builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-046 starttime: 1484519676.09 results: success (0) buildid: 20170115143421 builduid: 5824f26343624ffa8a8bdcbdaec7efb6 revision: 651fbecc80af7f31d8dfb5769482034cbef4d2a3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.092706) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.093170) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.093469) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.150196) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.150468) ========= 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=652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-01-15 14:34:36-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 230M=0s 2017-01-15 14:34:36 (230 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.225213 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.397445) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.397736) ========= 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=652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.050254 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:36.461813) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-01-15 14:34:36.462182) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 651fbecc80af7f31d8dfb5769482034cbef4d2a3 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 651fbecc80af7f31d8dfb5769482034cbef4d2a3 --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=652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-01-15 14:34:36,546 truncating revision to first 12 chars 2017-01-15 14:34:36,546 Setting DEBUG logging. 2017-01-15 14:34:36,546 attempt 1/10 2017-01-15 14:34:36,546 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/651fbecc80af?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-01-15 14:34:37,402 unpacking tar archive at: mozilla-inbound-651fbecc80af/testing/mozharness/ program finished with exit code 0 elapsedTime=1.241226 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-01-15 14:34:37.713603) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:37.713906) ========= script_repo_revision: 651fbecc80af7f31d8dfb5769482034cbef4d2a3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:37.714375) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:37.714786) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-01-15 14:34:37.724566) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-01-15 14:34:37.725050) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 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', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 14:34:38 INFO - MultiFileLogger online at 20170115 14:34:38 in /builds/slave/test 14:34:38 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 14:34:38 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 14:34:38 INFO - {'append_to_log': False, 14:34:38 INFO - 'base_work_dir': '/builds/slave/test', 14:34:38 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 14:34:38 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 14:34:38 INFO - 'branch': 'Mozilla-Inbound', 14:34:38 INFO - 'buildbot_json_path': 'buildprops.json', 14:34:38 INFO - 'config_files': ('talos/linux_config.py',), 14:34:38 INFO - 'default_actions': ('clobber', 14:34:38 INFO - 'read-buildbot-config', 14:34:38 INFO - 'download-and-extract', 14:34:38 INFO - 'populate-webroot', 14:34:38 INFO - 'create-virtualenv', 14:34:38 INFO - 'install', 14:34:38 INFO - 'run-tests'), 14:34:38 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:34:38 INFO - 'download_minidump_stackwalk': True, 14:34:38 INFO - 'download_symbols': 'ondemand', 14:34:38 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:34:38 INFO - 'tooltool.py': '/tools/tooltool.py', 14:34:38 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:34:38 INFO - '/tools/misc-python/virtualenv.py')}, 14:34:38 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:34:38 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:34:38 INFO - 'installer_path': 'installer.exe', 14:34:38 INFO - 'log_level': 'info', 14:34:38 INFO - 'log_name': 'talos', 14:34:38 INFO - 'log_to_console': True, 14:34:38 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 14:34:38 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 14:34:38 INFO - 'opt_config_files': (), 14:34:38 INFO - 'pip_index': False, 14:34:38 INFO - 'sps_profile': False, 14:34:38 INFO - 'sps_profile_interval': 0, 14:34:38 INFO - 'suite': 'dromaeojs', 14:34:38 INFO - 'system_bits': '32', 14:34:38 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:34:38 INFO - 'title': 'talos-linux64-ix-046', 14:34:38 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:34:38 INFO - 'use_talos_json': True, 14:34:38 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 14:34:38 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:34:38 INFO - 'work_dir': 'build'} 14:34:38 INFO - [mozharness: 2017-01-15 22:34:38.034528Z] Running clobber step. 14:34:38 INFO - Running pre-action listener: _resource_record_pre_action 14:34:38 INFO - Running main action method: clobber 14:34:38 INFO - rmtree: /builds/slave/test/build 14:34:38 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 14:34:42 INFO - Running post-action listener: _resource_record_post_action 14:34:42 INFO - [mozharness: 2017-01-15 22:34:42.372370Z] Finished clobber step (success) 14:34:42 INFO - [mozharness: 2017-01-15 22:34:42.372470Z] Running read-buildbot-config step. 14:34:42 INFO - Running pre-action listener: _resource_record_pre_action 14:34:42 INFO - Running main action method: read_buildbot_config 14:34:42 INFO - Using buildbot properties: 14:34:42 INFO - { 14:34:42 INFO - "project": "", 14:34:42 INFO - "product": "firefox", 14:34:42 INFO - "script_repo_revision": "production", 14:34:42 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 14:34:42 INFO - "repository": "", 14:34:42 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 14:34:42 INFO - "buildid": "20170115143421", 14:34:42 INFO - "stage_platform": "linux64-pgo", 14:34:42 INFO - "basedir": "/builds/slave/test", 14:34:42 INFO - "buildnumber": 2451, 14:34:42 INFO - "platform": "ubuntu64_hw", 14:34:42 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 14:34:42 INFO - "slavebuilddir": "test", 14:34:42 INFO - "branch": "mozilla-inbound", 14:34:42 INFO - "revision": "651fbecc80af7f31d8dfb5769482034cbef4d2a3", 14:34:42 INFO - "slavename": "talos-linux64-ix-046", 14:34:42 INFO - "builduid": "5824f26343624ffa8a8bdcbdaec7efb6", 14:34:42 INFO - "repo_path": "integration/mozilla-inbound" 14:34:42 INFO - } 14:34:42 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2. 14:34:42 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.test_packages.json. 14:34:42 INFO - Running post-action listener: _resource_record_post_action 14:34:42 INFO - [mozharness: 2017-01-15 22:34:42.374835Z] Finished read-buildbot-config step (success) 14:34:42 INFO - [mozharness: 2017-01-15 22:34:42.374925Z] Running download-and-extract step. 14:34:42 INFO - Running pre-action listener: _resource_record_pre_action 14:34:42 INFO - Running main action method: download_and_extract 14:34:42 INFO - mkdir: /builds/slave/test/build/tests 14:34:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:34:42 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 14:34:42 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 14:34:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 14:34:42 INFO - Downloaded 1361 bytes. 14:34:42 INFO - Reading from file /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 14:34:42 INFO - Using the following test package requirements: 14:34:42 INFO - {u'common': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 14:34:42 INFO - u'cppunittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'firefox-53.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 14:34:42 INFO - u'gtest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'firefox-53.0a1.en-US.linux-x86_64.gtest.tests.zip'], 14:34:42 INFO - u'jittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'jsshell-linux-x86_64.zip'], 14:34:42 INFO - u'mochitest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'firefox-53.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 14:34:42 INFO - u'mozbase': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 14:34:42 INFO - u'reftest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'firefox-53.0a1.en-US.linux-x86_64.reftest.tests.zip'], 14:34:42 INFO - u'talos': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'], 14:34:42 INFO - u'web-platform': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'firefox-53.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 14:34:42 INFO - u'xpcshell': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 14:34:42 INFO - u'firefox-53.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 14:34:42 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 14:34:42 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 14:34:42 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:34:42 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 14:34:43 INFO - Expected file size: 21860828 14:34:43 INFO - Obtained file size: 21860828 14:34:47 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 14:34:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 14:34:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:34:47 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 14:34:47 INFO - Expected file size: 21860828 14:34:47 INFO - Obtained file size: 21860828 14:34:52 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip 14:34:52 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 14:34:52 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip into memory 14:34:55 INFO - Expected file size: 14403463 14:34:55 INFO - Obtained file size: 14403463 14:34:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:34:55 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 14:34:55 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 14:34:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 14:35:00 INFO - Downloaded 61736224 bytes. 14:35:00 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 14:35:00 INFO - mkdir: /builds/slave/test/properties 14:35:00 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 14:35:00 INFO - Writing to file /builds/slave/test/properties/build_url 14:35:00 INFO - Contents: 14:35:00 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 14:35:00 INFO - Running post-action listener: _resource_record_post_action 14:35:00 INFO - Running post-action listener: set_extra_try_arguments 14:35:00 INFO - [mozharness: 2017-01-15 22:35:00.808817Z] Finished download-and-extract step (success) 14:35:00 INFO - [mozharness: 2017-01-15 22:35:00.809048Z] Running populate-webroot step. 14:35:00 INFO - Running pre-action listener: _resource_record_pre_action 14:35:00 INFO - Running main action method: populate_webroot 14:35:00 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:35:00 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:35:00 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:35:00 INFO - '--tppagecycles', 14:35:00 INFO - '7'], 14:35:00 INFO - 'tests': ['tsvgm']}}, 14:35:00 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:35:00 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 14:35:00 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['dromaeo_css', 'kraken']}, 14:35:00 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 14:35:00 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 14:35:00 INFO - 'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:35:00 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 14:35:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:35:00 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 14:35:00 INFO - 'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['damp', 'tps']}, 14:35:00 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 14:35:00 INFO - 'tests': ['damp', 'tps']}, 14:35:00 INFO - 'g3': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['dromaeo_dom']}, 14:35:00 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:35:00 INFO - 'g4': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['basic_compositor_video']}, 14:35:00 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 14:35:00 INFO - 'other': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['a11yr', 14:35:00 INFO - 'ts_paint', 14:35:00 INFO - 'tpaint', 14:35:00 INFO - 'sessionrestore', 14:35:00 INFO - 'sessionrestore_no_auto_restore', 14:35:00 INFO - 'tabpaint']}, 14:35:00 INFO - 'other-e10s': {'tests': ['a11yr', 14:35:00 INFO - 'ts_paint', 14:35:00 INFO - 'tpaint', 14:35:00 INFO - 'sessionrestore', 14:35:00 INFO - 'sessionrestore_no_auto_restore', 14:35:00 INFO - 'tabpaint']}, 14:35:00 INFO - 'other-e10s_l64': {'tests': ['a11yr', 14:35:00 INFO - 'ts_paint', 14:35:00 INFO - 'tpaint', 14:35:00 INFO - 'sessionrestore', 14:35:00 INFO - 'sessionrestore_no_auto_restore', 14:35:00 INFO - 'tabpaint']}, 14:35:00 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 14:35:00 INFO - 'ts_paint', 14:35:00 INFO - 'tpaint', 14:35:00 INFO - 'sessionrestore', 14:35:00 INFO - 'sessionrestore_no_auto_restore', 14:35:00 INFO - 'tabpaint']}, 14:35:00 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['a11yr', 14:35:00 INFO - 'ts_paint', 14:35:00 INFO - 'tpaint', 14:35:00 INFO - 'sessionrestore', 14:35:00 INFO - 'sessionrestore_no_auto_restore', 14:35:00 INFO - 'tabpaint']}, 14:35:00 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['a11yr', 14:35:00 INFO - 'ts_paint', 14:35:00 INFO - 'tpaint', 14:35:00 INFO - 'sessionrestore', 14:35:00 INFO - 'sessionrestore_no_auto_restore', 14:35:00 INFO - 'tabpaint']}, 14:35:00 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['tsvgx', 14:35:00 INFO - 'tsvgr_opacity', 14:35:00 INFO - 'tart', 14:35:00 INFO - 'tscrollx', 14:35:00 INFO - 'cart', 14:35:00 INFO - 'tsvg_static']}, 14:35:00 INFO - 'svgr-e10s': {'tests': ['tsvgx', 14:35:00 INFO - 'tsvgr_opacity', 14:35:00 INFO - 'tart', 14:35:00 INFO - 'tscrollx', 14:35:00 INFO - 'cart', 14:35:00 INFO - 'tsvg_static']}, 14:35:00 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 14:35:00 INFO - 'talos_options': ['--disable-e10s'], 14:35:00 INFO - 'tests': ['tp5o']}, 14:35:00 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 14:35:00 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 14:35:00 INFO - 'talos_options': ['--disable-e10s', 14:35:00 INFO - '--xperf_path', 14:35:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:35:00 INFO - 'tests': ['tp5n']}, 14:35:00 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 14:35:00 INFO - 'talos_options': ['--xperf_path', 14:35:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:35:00 INFO - 'tests': ['tp5n']}}, 14:35:00 INFO - 'talos.zip': {'path': '', 14:35:00 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:35:00 INFO - Running post-action listener: _resource_record_post_action 14:35:00 INFO - [mozharness: 2017-01-15 22:35:00.831292Z] Finished populate-webroot step (success) 14:35:00 INFO - [mozharness: 2017-01-15 22:35:00.831392Z] Running create-virtualenv step. 14:35:00 INFO - Running pre-action listener: _resource_record_pre_action 14:35:00 INFO - Running main action method: create_virtualenv 14:35:00 INFO - Creating virtualenv /builds/slave/test/build/venv 14:35:00 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 14:35:00 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 14:35:00 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:35:00 INFO - Using real prefix '/usr' 14:35:00 INFO - New python executable in /builds/slave/test/build/venv/bin/python 14:35:01 INFO - Installing distribute.............................................................................................................................................................................................done. 14:35:04 INFO - Installing pip.................done. 14:35:04 INFO - Return code: 0 14:35:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 14:35:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 14:35:04 INFO - Reading from file tmpfile_stdout 14:35:04 INFO - Output received: 14:35:04 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 14:35:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 14:35:04 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')]} 14:35:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:04 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')]} 14:35:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:04 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:04 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 14:35:04 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 14:35:04 INFO - Using env: {'DISPLAY': ':0', 14:35:04 INFO - 'HOME': '/home/cltbld', 14:35:04 INFO - 'LANG': 'en_US.UTF-8', 14:35:04 INFO - 'LANGUAGE': 'en_US:en', 14:35:04 INFO - 'LOGNAME': 'cltbld', 14:35:04 INFO - 'MAIL': '/var/mail/cltbld', 14:35:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:04 INFO - 'MOZ_NO_REMOTE': '1', 14:35:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:04 INFO - 'NO_EM_RESTART': '1', 14:35:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:04 INFO - 'PWD': '/builds/slave/test', 14:35:04 INFO - 'SHELL': '/bin/bash', 14:35:04 INFO - 'SHLVL': '1', 14:35:04 INFO - 'TERM': 'linux', 14:35:04 INFO - 'TMOUT': '86400', 14:35:04 INFO - 'USER': 'cltbld', 14:35:04 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:04 INFO - '_': '/tools/buildbot/bin/python'} 14:35:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:04 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 14:35:04 INFO - Cleaning up... 14:35:04 INFO - Return code: 0 14:35:04 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 14:35:04 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')]} 14:35:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:04 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')]} 14:35:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:04 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:04 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 14:35:04 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 14:35:04 INFO - Using env: {'DISPLAY': ':0', 14:35:04 INFO - 'HOME': '/home/cltbld', 14:35:04 INFO - 'LANG': 'en_US.UTF-8', 14:35:04 INFO - 'LANGUAGE': 'en_US:en', 14:35:04 INFO - 'LOGNAME': 'cltbld', 14:35:04 INFO - 'MAIL': '/var/mail/cltbld', 14:35:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:04 INFO - 'MOZ_NO_REMOTE': '1', 14:35:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:04 INFO - 'NO_EM_RESTART': '1', 14:35:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:04 INFO - 'PWD': '/builds/slave/test', 14:35:04 INFO - 'SHELL': '/bin/bash', 14:35:04 INFO - 'SHLVL': '1', 14:35:04 INFO - 'TERM': 'linux', 14:35:04 INFO - 'TMOUT': '86400', 14:35:04 INFO - 'USER': 'cltbld', 14:35:04 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:04 INFO - '_': '/tools/buildbot/bin/python'} 14:35:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:05 INFO - Downloading/unpacking psutil>=3.1.1 14:35:05 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 14:35:05 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 14:35:05 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 14:35:05 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 14:35:05 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 14:35:05 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 14:35:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 14:35:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:35:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:35:07 INFO - Installing collected packages: psutil 14:35:07 INFO - Running setup.py install for psutil 14:35:07 INFO - building 'psutil._psutil_linux' extension 14:35:07 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 14:35:08 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 14:35:08 INFO - building 'psutil._psutil_posix' extension 14:35:08 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 14:35:08 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 14:35:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:35:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:35:08 INFO - Successfully installed psutil 14:35:08 INFO - Cleaning up... 14:35:08 INFO - Return code: 0 14:35:08 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 14:35:08 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')]} 14:35:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:08 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')]} 14:35:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:08 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:08 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 14:35:08 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 14:35:08 INFO - Using env: {'DISPLAY': ':0', 14:35:08 INFO - 'HOME': '/home/cltbld', 14:35:08 INFO - 'LANG': 'en_US.UTF-8', 14:35:08 INFO - 'LANGUAGE': 'en_US:en', 14:35:08 INFO - 'LOGNAME': 'cltbld', 14:35:08 INFO - 'MAIL': '/var/mail/cltbld', 14:35:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:08 INFO - 'MOZ_NO_REMOTE': '1', 14:35:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:08 INFO - 'NO_EM_RESTART': '1', 14:35:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:08 INFO - 'PWD': '/builds/slave/test', 14:35:08 INFO - 'SHELL': '/bin/bash', 14:35:08 INFO - 'SHLVL': '1', 14:35:08 INFO - 'TERM': 'linux', 14:35:08 INFO - 'TMOUT': '86400', 14:35:08 INFO - 'USER': 'cltbld', 14:35:08 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:08 INFO - '_': '/tools/buildbot/bin/python'} 14:35:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:09 INFO - Downloading/unpacking mozsystemmonitor==0.3 14:35:09 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 14:35:09 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 14:35:09 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 14:35:09 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 14:35:09 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 14:35:09 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 14:35:11 INFO - Downloading mozsystemmonitor-0.3.tar.gz 14:35:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:35:11 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 14:35:11 INFO - Installing collected packages: mozsystemmonitor 14:35:11 INFO - Running setup.py install for mozsystemmonitor 14:35:11 INFO - Successfully installed mozsystemmonitor 14:35:11 INFO - Cleaning up... 14:35:11 INFO - Return code: 0 14:35:11 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 14:35:11 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')]} 14:35:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:11 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')]} 14:35:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:11 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:11 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 14:35:11 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 14:35:11 INFO - Using env: {'DISPLAY': ':0', 14:35:11 INFO - 'HOME': '/home/cltbld', 14:35:11 INFO - 'LANG': 'en_US.UTF-8', 14:35:11 INFO - 'LANGUAGE': 'en_US:en', 14:35:11 INFO - 'LOGNAME': 'cltbld', 14:35:11 INFO - 'MAIL': '/var/mail/cltbld', 14:35:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:11 INFO - 'MOZ_NO_REMOTE': '1', 14:35:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:11 INFO - 'NO_EM_RESTART': '1', 14:35:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:11 INFO - 'PWD': '/builds/slave/test', 14:35:11 INFO - 'SHELL': '/bin/bash', 14:35:11 INFO - 'SHLVL': '1', 14:35:11 INFO - 'TERM': 'linux', 14:35:11 INFO - 'TMOUT': '86400', 14:35:11 INFO - 'USER': 'cltbld', 14:35:11 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:11 INFO - '_': '/tools/buildbot/bin/python'} 14:35:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:11 INFO - Downloading/unpacking jsonschema==2.5.1 14:35:11 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 14:35:11 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 14:35:11 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 14:35:11 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 14:35:11 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 14:35:11 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 14:35:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:35:13 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 14:35:13 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 14:35:13 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 14:35:13 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 14:35:13 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 14:35:13 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 14:35:13 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 14:35:13 INFO - Downloading functools32-3.2.3-2.tar.gz 14:35:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 14:35:13 INFO - warning: no files found matching '*.txt' 14:35:13 INFO - no previously-included directories found matching 'build' 14:35:13 INFO - no previously-included directories found matching 'dist' 14:35:13 INFO - no previously-included directories found matching '.git*' 14:35:13 INFO - Installing collected packages: jsonschema, functools32 14:35:13 INFO - Running setup.py install for functools32 14:35:13 INFO - warning: no files found matching '*.txt' 14:35:13 INFO - no previously-included directories found matching 'build' 14:35:13 INFO - no previously-included directories found matching 'dist' 14:35:13 INFO - no previously-included directories found matching '.git*' 14:35:13 INFO - Successfully installed jsonschema functools32 14:35:13 INFO - Cleaning up... 14:35:14 INFO - Return code: 0 14:35:14 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 14:35:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:14 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:14 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 14:35:14 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 14:35:14 INFO - Using env: {'DISPLAY': ':0', 14:35:14 INFO - 'HOME': '/home/cltbld', 14:35:14 INFO - 'LANG': 'en_US.UTF-8', 14:35:14 INFO - 'LANGUAGE': 'en_US:en', 14:35:14 INFO - 'LOGNAME': 'cltbld', 14:35:14 INFO - 'MAIL': '/var/mail/cltbld', 14:35:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:14 INFO - 'MOZ_NO_REMOTE': '1', 14:35:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:14 INFO - 'NO_EM_RESTART': '1', 14:35:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:14 INFO - 'PWD': '/builds/slave/test', 14:35:14 INFO - 'SHELL': '/bin/bash', 14:35:14 INFO - 'SHLVL': '1', 14:35:14 INFO - 'TERM': 'linux', 14:35:14 INFO - 'TMOUT': '86400', 14:35:14 INFO - 'USER': 'cltbld', 14:35:14 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:14 INFO - '_': '/tools/buildbot/bin/python'} 14:35:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:14 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 14:35:14 INFO - Cleaning up... 14:35:14 INFO - Return code: 0 14:35:14 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 14:35:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:14 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:14 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 14:35:14 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 14:35:14 INFO - Using env: {'DISPLAY': ':0', 14:35:14 INFO - 'HOME': '/home/cltbld', 14:35:14 INFO - 'LANG': 'en_US.UTF-8', 14:35:14 INFO - 'LANGUAGE': 'en_US:en', 14:35:14 INFO - 'LOGNAME': 'cltbld', 14:35:14 INFO - 'MAIL': '/var/mail/cltbld', 14:35:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:14 INFO - 'MOZ_NO_REMOTE': '1', 14:35:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:14 INFO - 'NO_EM_RESTART': '1', 14:35:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:14 INFO - 'PWD': '/builds/slave/test', 14:35:14 INFO - 'SHELL': '/bin/bash', 14:35:14 INFO - 'SHLVL': '1', 14:35:14 INFO - 'TERM': 'linux', 14:35:14 INFO - 'TMOUT': '86400', 14:35:14 INFO - 'USER': 'cltbld', 14:35:14 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:14 INFO - '_': '/tools/buildbot/bin/python'} 14:35:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:14 INFO - Downloading/unpacking blobuploader==1.2.4 14:35:14 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 14:35:14 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 14:35:14 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 14:35:14 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 14:35:14 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 14:35:14 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 14:35:16 INFO - Downloading blobuploader-1.2.4.tar.gz 14:35:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:35:16 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:35:16 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 14:35:16 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 14:35:16 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 14:35:16 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 14:35:16 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 14:35:16 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 14:35:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 14:35:16 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:35:16 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 14:35:16 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 14:35:16 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 14:35:16 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 14:35:16 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 14:35:16 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 14:35:17 INFO - Downloading docopt-0.6.1.tar.gz 14:35:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 14:35:17 INFO - Installing collected packages: blobuploader, requests, docopt 14:35:17 INFO - Running setup.py install for blobuploader 14:35:17 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:35:17 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 14:35:17 INFO - Running setup.py install for requests 14:35:17 INFO - Running setup.py install for docopt 14:35:17 INFO - Successfully installed blobuploader requests docopt 14:35:17 INFO - Cleaning up... 14:35:17 INFO - Return code: 0 14:35:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:35: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')]} 14:35:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35: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')]} 14:35:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:17 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:17 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 14:35:17 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 14:35:17 INFO - Using env: {'DISPLAY': ':0', 14:35:17 INFO - 'HOME': '/home/cltbld', 14:35:17 INFO - 'LANG': 'en_US.UTF-8', 14:35:17 INFO - 'LANGUAGE': 'en_US:en', 14:35:17 INFO - 'LOGNAME': 'cltbld', 14:35:17 INFO - 'MAIL': '/var/mail/cltbld', 14:35:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:17 INFO - 'MOZ_NO_REMOTE': '1', 14:35:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:17 INFO - 'NO_EM_RESTART': '1', 14:35:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:17 INFO - 'PWD': '/builds/slave/test', 14:35:17 INFO - 'SHELL': '/bin/bash', 14:35:17 INFO - 'SHLVL': '1', 14:35:17 INFO - 'TERM': 'linux', 14:35:17 INFO - 'TMOUT': '86400', 14:35:17 INFO - 'USER': 'cltbld', 14:35:17 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:17 INFO - '_': '/tools/buildbot/bin/python'} 14:35:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:35:18 INFO - Running setup.py (path:/tmp/pip-Wkx02J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:35:18 INFO - Running setup.py (path:/tmp/pip-GygBWc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:35:18 INFO - Running setup.py (path:/tmp/pip-LvBnTm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:35:18 INFO - Running setup.py (path:/tmp/pip-zjTNHr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:35:18 INFO - Running setup.py (path:/tmp/pip-9jlOec-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:35:18 INFO - Running setup.py (path:/tmp/pip-VGLxSa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:35:18 INFO - Running setup.py (path:/tmp/pip-mP5BoL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:35:18 INFO - Running setup.py (path:/tmp/pip-gxmR3z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:35:18 INFO - Running setup.py (path:/tmp/pip-GyRfrv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:35:18 INFO - Running setup.py (path:/tmp/pip-hnmz7C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:35:18 INFO - Running setup.py (path:/tmp/pip-sj50nb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:35:18 INFO - Running setup.py (path:/tmp/pip-LZ6FG_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:35:18 INFO - Running setup.py (path:/tmp/pip-OsBj4n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:35:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:35:18 INFO - Running setup.py (path:/tmp/pip-QUQDgJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:35:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:35:19 INFO - Running setup.py (path:/tmp/pip-zp8dca-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:35:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:35:19 INFO - Running setup.py (path:/tmp/pip-dRpuLD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:35:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:35:19 INFO - Running setup.py (path:/tmp/pip-OeFDEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:35:19 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:35:19 INFO - Running setup.py install for manifestparser 14:35:19 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 14:35:19 INFO - Running setup.py install for mozcrash 14:35:19 INFO - Running setup.py install for mozdebug 14:35:19 INFO - Running setup.py install for mozdevice 14:35:19 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 14:35:19 INFO - Installing dm script to /builds/slave/test/build/venv/bin 14:35:19 INFO - Running setup.py install for mozfile 14:35:19 INFO - Running setup.py install for mozhttpd 14:35:19 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 14:35:19 INFO - Running setup.py install for mozinfo 14:35:19 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 14:35:19 INFO - Running setup.py install for mozInstall 14:35:20 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Running setup.py install for mozleak 14:35:20 INFO - Running setup.py install for mozlog 14:35:20 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Running setup.py install for moznetwork 14:35:20 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Running setup.py install for mozprocess 14:35:20 INFO - Running setup.py install for mozprofile 14:35:20 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Running setup.py install for mozrunner 14:35:20 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 14:35:20 INFO - Running setup.py install for mozscreenshot 14:35:20 INFO - Running setup.py install for moztest 14:35:20 INFO - Running setup.py install for mozversion 14:35:21 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 14:35:21 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:35:21 INFO - Cleaning up... 14:35:21 INFO - Return code: 0 14:35:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:35:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:21 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:21 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 14:35:21 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 14:35:21 INFO - Using env: {'DISPLAY': ':0', 14:35:21 INFO - 'HOME': '/home/cltbld', 14:35:21 INFO - 'LANG': 'en_US.UTF-8', 14:35:21 INFO - 'LANGUAGE': 'en_US:en', 14:35:21 INFO - 'LOGNAME': 'cltbld', 14:35:21 INFO - 'MAIL': '/var/mail/cltbld', 14:35:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:21 INFO - 'MOZ_NO_REMOTE': '1', 14:35:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:21 INFO - 'NO_EM_RESTART': '1', 14:35:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:21 INFO - 'PWD': '/builds/slave/test', 14:35:21 INFO - 'SHELL': '/bin/bash', 14:35:21 INFO - 'SHLVL': '1', 14:35:21 INFO - 'TERM': 'linux', 14:35:21 INFO - 'TMOUT': '86400', 14:35:21 INFO - 'USER': 'cltbld', 14:35:21 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:21 INFO - '_': '/tools/buildbot/bin/python'} 14:35:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:35:21 INFO - Running setup.py (path:/tmp/pip-z4DEK7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:35:21 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)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:35:21 INFO - Running setup.py (path:/tmp/pip-ada3Zm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:35:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:35:21 INFO - Running setup.py (path:/tmp/pip-elAIFe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:35:21 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)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:35:21 INFO - Running setup.py (path:/tmp/pip-U1YOdz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:35:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:35:21 INFO - Running setup.py (path:/tmp/pip-EjrJTr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:35:21 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)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:35:21 INFO - Running setup.py (path:/tmp/pip-TIXIeu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:35:21 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)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:35:21 INFO - Running setup.py (path:/tmp/pip-s2UMeo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:35:21 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)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:35:21 INFO - Running setup.py (path:/tmp/pip-RhCXIE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:35:21 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)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:35:21 INFO - Running setup.py (path:/tmp/pip-p9AK19-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:35:21 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)) 14:35:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:35:21 INFO - Running setup.py (path:/tmp/pip-c_xPkP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:35:22 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)) 14:35:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:35:22 INFO - Running setup.py (path:/tmp/pip-vS6_Vw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:35:22 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)) 14:35:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:35:22 INFO - Running setup.py (path:/tmp/pip-bsiOEa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:35:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 14:35:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:35:22 INFO - Running setup.py (path:/tmp/pip-fL4sEV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:35:22 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)) 14:35:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:35:22 INFO - Running setup.py (path:/tmp/pip-EEvXEb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:35:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 14:35:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:35:22 INFO - Running setup.py (path:/tmp/pip-9fqpBm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:35:22 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)) 14:35:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:35:22 INFO - Running setup.py (path:/tmp/pip-DY7Ej7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:35:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 14:35:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:35:22 INFO - Running setup.py (path:/tmp/pip-8lTD3j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:35:22 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)) 14:35:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:35:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:35:22 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)) 14:35:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:35:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:35:22 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:35:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:35:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:35:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:35:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:35:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:35:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:35:24 INFO - Downloading blessings-1.6.tar.gz 14:35:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 14:35:24 INFO - Installing collected packages: blessings 14:35:24 INFO - Running setup.py install for blessings 14:35:24 INFO - Successfully installed blessings 14:35:24 INFO - Cleaning up... 14:35:24 INFO - Return code: 0 14:35:24 INFO - Done creating virtualenv /builds/slave/test/build/venv. 14:35:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:35:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:35:25 INFO - Reading from file tmpfile_stdout 14:35:25 INFO - Current package versions: 14:35:25 INFO - argparse == 1.2.1 14:35:25 INFO - blessings == 1.6 14:35:25 INFO - blobuploader == 1.2.4 14:35:25 INFO - docopt == 0.6.1 14:35:25 INFO - functools32 == 3.2.3-2 14:35:25 INFO - jsonschema == 2.5.1 14:35:25 INFO - manifestparser == 1.1 14:35:25 INFO - mozInstall == 1.12 14:35:25 INFO - mozcrash == 1.0 14:35:25 INFO - mozdebug == 0.1 14:35:25 INFO - mozdevice == 0.49 14:35:25 INFO - mozfile == 1.2 14:35:25 INFO - mozhttpd == 0.7 14:35:25 INFO - mozinfo == 0.9 14:35:25 INFO - mozleak == 0.1 14:35:25 INFO - mozlog == 3.4 14:35:25 INFO - moznetwork == 0.27 14:35:25 INFO - mozprocess == 0.24 14:35:25 INFO - mozprofile == 0.28 14:35:25 INFO - mozrunner == 6.13 14:35:25 INFO - mozscreenshot == 0.1 14:35:25 INFO - mozsystemmonitor == 0.3 14:35:25 INFO - moztest == 0.8 14:35:25 INFO - mozversion == 1.4 14:35:25 INFO - psutil == 3.1.1 14:35:25 INFO - requests == 1.2.3 14:35:25 INFO - wsgiref == 0.1.2 14:35:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:35:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:25 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 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:25 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 14:35:25 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 14:35:25 INFO - Using env: {'DISPLAY': ':0', 14:35:25 INFO - 'HOME': '/home/cltbld', 14:35:25 INFO - 'LANG': 'en_US.UTF-8', 14:35:25 INFO - 'LANGUAGE': 'en_US:en', 14:35:25 INFO - 'LOGNAME': 'cltbld', 14:35:25 INFO - 'MAIL': '/var/mail/cltbld', 14:35:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:25 INFO - 'MOZ_NO_REMOTE': '1', 14:35:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:25 INFO - 'NO_EM_RESTART': '1', 14:35:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:25 INFO - 'PWD': '/builds/slave/test', 14:35:25 INFO - 'SHELL': '/bin/bash', 14:35:25 INFO - 'SHLVL': '1', 14:35:25 INFO - 'TERM': 'linux', 14:35:25 INFO - 'TMOUT': '86400', 14:35:25 INFO - 'USER': 'cltbld', 14:35:25 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:25 INFO - '_': '/tools/buildbot/bin/python'} 14:35:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 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)) 14:35:25 INFO - Cleaning up... 14:35:25 INFO - Return code: 0 14:35:25 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 14:35:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:35:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:35:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:35:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a0e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b1ea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d80630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, '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': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', '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 14:35:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 14:35:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 14:35:25 INFO - Using env: {'DISPLAY': ':0', 14:35:25 INFO - 'HOME': '/home/cltbld', 14:35:25 INFO - 'LANG': 'en_US.UTF-8', 14:35:25 INFO - 'LANGUAGE': 'en_US:en', 14:35:25 INFO - 'LOGNAME': 'cltbld', 14:35:25 INFO - 'MAIL': '/var/mail/cltbld', 14:35:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:25 INFO - 'MOZ_NO_REMOTE': '1', 14:35:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:25 INFO - 'NO_EM_RESTART': '1', 14:35:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:25 INFO - 'PWD': '/builds/slave/test', 14:35:25 INFO - 'SHELL': '/bin/bash', 14:35:25 INFO - 'SHLVL': '1', 14:35:25 INFO - 'TERM': 'linux', 14:35:25 INFO - 'TMOUT': '86400', 14:35:25 INFO - 'USER': 'cltbld', 14:35:25 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:25 INFO - '_': '/tools/buildbot/bin/python'} 14:35:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:35:25 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 14:35:25 INFO - Cleaning up... 14:35:25 INFO - Return code: 0 14:35:25 INFO - Running post-action listener: _resource_record_post_action 14:35:25 INFO - Running post-action listener: _start_resource_monitoring 14:35:25 INFO - Starting resource monitoring. 14:35:25 INFO - [mozharness: 2017-01-15 22:35:25.516472Z] Finished create-virtualenv step (success) 14:35:25 INFO - [mozharness: 2017-01-15 22:35:25.517417Z] Running install step. 14:35:25 INFO - Running pre-action listener: _resource_record_pre_action 14:35:25 INFO - Running main action method: install 14:35:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:35:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:35:25 INFO - Reading from file tmpfile_stdout 14:35:25 INFO - Detecting whether we're running mozinstall >=1.0... 14:35:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 14:35:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 14:35:25 INFO - Reading from file tmpfile_stdout 14:35:25 INFO - Output received: 14:35:25 INFO - Usage: mozinstall [options] installer 14:35:25 INFO - Options: 14:35:25 INFO - -h, --help show this help message and exit 14:35:25 INFO - -d DEST, --destination=DEST 14:35:25 INFO - Directory to install application into. [default: 14:35:25 INFO - "/builds/slave/test"] 14:35:25 INFO - --app=APP Application being installed. [default: firefox] 14:35:25 INFO - mkdir: /builds/slave/test/build/application 14:35:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 14:35:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 14:35:43 INFO - Reading from file tmpfile_stdout 14:35:43 INFO - Output received: 14:35:43 INFO - /builds/slave/test/build/application/firefox/firefox 14:35:43 INFO - Running post-action listener: _resource_record_post_action 14:35:43 INFO - [mozharness: 2017-01-15 22:35:43.253921Z] Finished install step (success) 14:35:43 INFO - [mozharness: 2017-01-15 22:35:43.254199Z] Running run-tests step. 14:35:43 INFO - Running pre-action listener: _resource_record_pre_action 14:35:43 INFO - Running main action method: run_tests 14:35:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 14:35:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 14:35:43 INFO - Python 2.7.3 14:35:43 INFO - Return code: 0 14:35:43 INFO - grabbing minidump binary from tooltool 14:35:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:35:43 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 0x1e09850>, '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 0x1d7e6d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d7eb60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 14:35:43 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 14:35:43 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 14:35:43 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 14:35:43 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:35:43 INFO - Return code: 0 14:35:43 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 14:35:43 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 14:35:43 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 14:35:43 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 14:35:43 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 14:35:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--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 14:35:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-046 --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 14:35:43 INFO - Using env: {'DISPLAY': ':0', 14:35:43 INFO - 'HOME': '/home/cltbld', 14:35:43 INFO - 'LANG': 'en_US.UTF-8', 14:35:43 INFO - 'LANGUAGE': 'en_US:en', 14:35:43 INFO - 'LOGNAME': 'cltbld', 14:35:43 INFO - 'MAIL': '/var/mail/cltbld', 14:35:43 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 14:35:43 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 14:35:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:35:43 INFO - 'MOZ_NO_REMOTE': '1', 14:35:43 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 14:35:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:35:43 INFO - 'NO_EM_RESTART': '1', 14:35:43 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:35:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:35:43 INFO - 'PWD': '/builds/slave/test', 14:35:43 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 14:35:43 INFO - 'SHELL': '/bin/bash', 14:35:43 INFO - 'SHLVL': '1', 14:35:43 INFO - 'TERM': 'linux', 14:35:43 INFO - 'TMOUT': '86400', 14:35:43 INFO - 'USER': 'cltbld', 14:35:43 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504', 14:35:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:35:43 INFO - '_': '/tools/buildbot/bin/python'} 14:35:43 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--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 14:35:43 INFO - mozversion application_buildid: 20170115123003 14:35:43 INFO - mozversion application_changeset: 651fbecc80af7f31d8dfb5769482034cbef4d2a3 14:35:43 INFO - mozversion application_display_name: Nightly 14:35:43 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:35:43 INFO - mozversion application_name: Firefox 14:35:43 INFO - mozversion application_remotingname: firefox 14:35:43 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 14:35:43 INFO - mozversion application_vendor: Mozilla 14:35:43 INFO - mozversion application_version: 53.0a1 14:35:43 INFO - mozversion platform_buildid: 20170115123003 14:35:43 INFO - mozversion platform_changeset: 651fbecc80af7f31d8dfb5769482034cbef4d2a3 14:35:43 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 14:35:43 INFO - mozversion platform_version: 53.0a1 14:35:43 INFO - using testdate: 1484519743 14:35:43 INFO - actual date: 1484519743 14:35:43 INFO - starting webserver on 'localhost:43465' 14:35:43 INFO - SUITE-START | Running 2 tests 14:35:43 INFO - TEST-START | dromaeo_css 14:35:43 INFO - operating with platform_type : linux_ 14:35:43 INFO - Initialising browser for dromaeo_css test... 14:35:43 INFO - TEST-INFO | started process 3314 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYJduRo/profile http://localhost:43465/getInfo.html) 14:35:49 INFO - PROCESS | 3314 | __metrics Screen width/height:1600/1200 14:35:49 INFO - PROCESS | 3314 | colorDepth:24 14:35:49 INFO - PROCESS | 3314 | Browser inner width/height: 1024/697 14:35:49 INFO - PROCESS | 3314 | __metrics 14:35:49 INFO - PROCESS | 3314 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 14:35:49 INFO - PROCESS | 3314 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:35:50 INFO - PROCESS | 3314 | console.error: PushService: 14:35:50 INFO - PROCESS | 3314 | stateChangeProcessEnqueue: Error transitioning state 14:35:50 INFO - PROCESS | 3314 | UnknownError 14:35:50 INFO - TEST-INFO | 3314: exit 0 14:35:50 INFO - Browser initialized. 14:35:50 INFO - Running cycle 1/1 for dromaeo_css test... 14:35:50 INFO - TEST-INFO | started process 3397 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYJduRo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:36:02 INFO - PROCESS | 3397 | RSS: Main: 148045824 14:36:02 INFO - PROCESS | 3397 | 14:39:04 INFO - PROCESS | 3397 | Cycle 1(1): loaded http://localhost:43465/tests/dromaeo/cssquery-dojo.html (next: http://localhost:43465/tests/dromaeo/cssquery-ext.html) 14:39:05 INFO - PROCESS | 3397 | RSS: Main: 267620352 14:39:05 INFO - PROCESS | 3397 | 14:40:52 INFO - PROCESS | 3397 | ************************* 14:40:52 INFO - PROCESS | 3397 | A coding exception was thrown and uncaught in a Task. 14:40:52 INFO - PROCESS | 3397 | 14:40:52 ERROR - PROCESS | 3397 | Full message: TypeError: NetworkError when attempting to fetch resource. 14:40:52 INFO - PROCESS | 3397 | Full stack: 14:40:52 INFO - PROCESS | 3397 | ************************* 14:42:08 INFO - PROCESS | 3397 | Cycle 1(1): loaded http://localhost:43465/tests/dromaeo/cssquery-ext.html (next: http://localhost:43465/tests/dromaeo/cssquery-jquery.html) 14:42:08 INFO - PROCESS | 3397 | RSS: Main: 241250304 14:42:08 INFO - PROCESS | 3397 | 14:45:10 INFO - PROCESS | 3397 | Cycle 1(1): loaded http://localhost:43465/tests/dromaeo/cssquery-jquery.html (next: http://localhost:43465/tests/dromaeo/cssquery-mootools.html) 14:45:11 INFO - PROCESS | 3397 | RSS: Main: 222105600 14:45:11 INFO - PROCESS | 3397 | 14:48:13 INFO - PROCESS | 3397 | Cycle 1(1): loaded http://localhost:43465/tests/dromaeo/cssquery-mootools.html (next: http://localhost:43465/tests/dromaeo/cssquery-prototype.html) 14:48:13 INFO - PROCESS | 3397 | RSS: Main: 182964224 14:48:13 INFO - PROCESS | 3397 | 14:51:16 INFO - PROCESS | 3397 | Cycle 1(1): loaded http://localhost:43465/tests/dromaeo/cssquery-prototype.html (next: http://localhost:43465/tests/dromaeo/cssquery-yui.html) 14:51:17 INFO - PROCESS | 3397 | RSS: Main: 183488512 14:51:17 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | Cycle 1(1): loaded http://localhost:43465/tests/dromaeo/cssquery-yui.html (next: http://localhost:43465/tests/dromaeo/cssquery-dojo.html) 14:54:19 INFO - PROCESS | 3397 | RSS: Main: 274321408 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | __start_tp_report 14:54:19 INFO - PROCESS | 3397 | _x_x_mozilla_page_load 14:54:19 INFO - PROCESS | 3397 | _x_x_mozilla_page_load_details 14:54:19 INFO - PROCESS | 3397 | |i|pagename|runs| 14:54:19 INFO - PROCESS | 3397 | |0;dojo.html;3137.8744850205994;3162.794418362808;3180.1890517917927;3185.4106990206815;3187.7449804015682;5131.743412829363;5199.934013527227;5257.0011697777445;5260.552853007494;5314.867128321789;5365.275687782138;5375.247465354853;5388.43421440749;5420.051490989081;5464.453554644533;4739.810407583693;4803.855884323476;4826.083044221604;4828.71027738335;4843.66094373394;4924.138275801721;4950.529699678525;4958.727270000149;4963.7021778693215;4976.402831660206;4644.674872758908;4671.766411679402;4672.579467847876;4870.732109733964;4890.584300334476;4726;4739.454962679301;4742.881427964294;4743.335932969387;4749.097671442415;4692.882677933045;4703.2474804031535;4705.976470117662;4712.505186955389;4726.102040612307;5190;5225.399079105876;5229.790808367698;5230.293910322096;5235.057689615867;5578.804741834017;5614.214010038598;5615.719214039282;5621.887562248732;5622.775088996435;5567.693776842272;5654.491095801356;5663.66018038919;5666.829995100154;5672.68800215988;5196.220566914955;5236.73816309183;5242.60680448964;5247.895042099175;5254.947450525522;5732.713364331767;5733.283339582552;5736.569757268138;5739.081746920473;5783.19035335045;5401.081816091274;5427.6200665953;5428.75570599324;5498.340199176125;5528.530074943595;5633.4084921082695;5636.60543761941;5638.633488823213;5642.548596112301;5647;5586.273784408001;5680.261565996477;5701.572382071361;5717.771289148387;5806.21616081832;5731.455511726379;5735.713214339266;5752.424757524214;5752.827415177551;5761.0782274836665;4485.820567177341;4491.169133710274;4507.774611269489;4510.684252102387;4544.0457503924545;3890.824912878927;3913.7064720146104;3983.14362412077;3986.3023970804993;3997;5483.588730845203;5489.725513724298;5490.890182196414;5492.5605951523785;5532.30846144232;5778.913316300259;5817.650940943472;5822.0975748758165;5826.82519524415;5831.154482599999;5235.607329450307;5270.70724234959;5280.419153893069;5431.891362172813;5495.395506494282;4882.340883980617;4904.509549045067;4907.484714105039;4940.90118197634;4985.5762260208285;5856.648601083949;5868.9706551467825;5917.497012753878;5925.200097986716;5927.2590926134235;5480.91778623313;5654.943450565442;5666;5666.9716651416475;5673.8297851064535;5691.373948865538;5727.4845263926445;5785.190073389645;5790.305163380422;5792.333881603501;5483.862903427446;5493.285872836505;5581.5255703265675;5650.434956504481;5697.145428185805;5836.503897168788;5843.2695913010875;5848.385919478394;5867.20792692981;5891.410858914074;5695.800646977336;5708.429157084258;5708.885822283448;5709.115087161496;5711.428857114422;5451.046066938191;5500.22996780459;5653.717314134195;5688.089905615082;5709;5667.829965101054;5674.120511320752;5699.487046165865;5707.857303567444;5715.028445164249;5600.719964001865;5667.093265077568;5685.829425117253;5686.60193786431;5689.459501347365;5283.920741188808;5316.521513063843;5554.055810512142;5557.194206839905;5561.249231353715 14:54:19 INFO - PROCESS | 3397 | |1;ext.html;542.7420873070901;570.7945139749689;605.560968297984;615.947644450222;665.5840099937539;35325.82337088314;45276;46102.7694861526;46122.76938615311;46271.30593041103;47463.05073898529;47910.760446197804;48006;48015.27977080346;48017.27974080392;8482.660693572281;8702.912970870273;8980.012198658158;9163.450192988443;9168.724938251864;10687.893121068768;11007.174461915389;11016.724581885437;11410.31538107712;11414.258073225255;10501.212409069312;10537.841932370982;10556.366618002907;10560.31357961734;10562.419066951315;10942.726431839188;10990.560377584927;11003.889961100447;11005.61480348184;11015.559377624886;10828.837567436494;10883.292585981964;10894.291871028357;10903.727406814814;10909.399983000932;45110.77444612756;45255.09489810185;45308.773456132505;45349.77325113386;45409.77295113536;4302.26861433557;4340.479142502888;4388.561143885618;4434.06884554244;4528.909421811578;32909.50635740466;33524;33573.83213083919;33672.49491257633;35026.29947401063;4321.481422229353;4365.5416181300825;4366;4402.977985110086;4431.290993441034;343066;343185;343981;344393;346289;64124.358756412774;64416.67791661012;64496.35503644904;64999.67500162469;65050;59470;59549;59676.70161649164;59803.700981495684;59980.40019599835;16370.345186192419;16395.918020409823;16408.75386869198;16435.342586296414;17317.82682173162;12029.458674359676;12290.75418491643;12669.809952850715;12711.173773704679;12985.091043626855;18899.81100189008;18970.14634341458;18975.71536426955;19039.52401189981;19056.809431905782;6335.36646335372;6361.300256971729;6374.776882809079;6470.352964703586;6520.8373938639725;954.8233576788316;963.4797209506928;975.068809287129;976.5507866381544;977.0815433492494;30863;33191.66808331886;33192.336153276796;33192.50211246833;33472.66527334695;1046.9633562825265;1125.4260327233005;1132.2753437799815;1152.815549512074;1156.9595064172713;16408.425705100504;16806.91596542034;17001.914990424968;17143.657126857393;17154.656906861794;467560;469156;471719;471955;472000;62474.37525624777;63088;63340.36659633437;63405;63463.68268158722;1430.1304059676818;1466.6213759066443;1466.7286551987704;1469.9706005879823;1499.9475018374305;30539.38921221519;32429.351412971137;32845.67154328426;33001.50497742584;33049.83475082609;53414;55154;55212.72393638167;55232.72383638056;55278.894422112135;383095;385863;386525;386575;387714;35938;38184;41972.580274196866;42123.15753684971;42366.36450453184;46246.53753462422;46702.299465508724;47390.76304618593;47855.28217076677;48943;39233.2153356937;39277;39385.60614393934;39670.60329396669;41497.37753933633;39029.02427439337;39570.208595827346;39657;39739.2052158961;41060.17879642331;38571.2285754289;39583.2083358337;39782.00544986399;40199.59800401959;40282.597174027884;31985.36029279355;33865.15337116592;34351.65648343485;34952.300953981285;35095.824520877235;26431.33921651974;26526.571346129003;26688.599671004562;26708;26836.731632683423 14:54:19 INFO - PROCESS | 3397 | |2;jquery.html;390.822175909961;400.175638185338;419.7901049475261;428.93994840722297;433.2375019964861;20545.280915167972;20708.896455517737;21055.47361315968;21075.156993720233;21377.67933480997;20788.792112078914;21016;21066.789332106673;21181.894090529564;21303.680444793303;5654.660720356782;5879.294484661847;5884.499817515495;5896.528277737792;5903.26209223847;5647.3505546862025;5789.131630255453;5792.160136780164;5815.185873977646;5845.210896528978;5791.362950075489;5794.565407594426;5796.188533605298;5799.246098007253;5800.506956908668;5781.566382521307;5875.588708790387;6106;6123.418275263887;6227.377262273736;5864.736086876058;6035.8305864544955;6088.786892458743;6089.786857460012;6091.451769340736;14472.348744306531;14709.411623535047;14761.483348082873;14789.630259243497;21694.566108677896;2664.004990642545;2781.916542503728;2880.5967164596973;2889.306566424064;2975.821450712964;10589.84115238272;10698.411587362692;10791;11212.831807522894;11299.604513841976;1915.3296346278692;1952.6094781043848;1967.9704804427945;2003.4690806936173;2025.9392218233477;92156.53921730416;97124.51437742836;98098;98751;100784.49607751914;11360.715982100513;11702.239354441934;11721.186915140304;11775.646730598095;11776.234544754563;15935.203239837962;15945.601359966093;15956.361745530048;15994.920025399799;16031.278592463366;8356.247937685515;8513.489190648581;8632.78418039554;8857.11428857109;8877.1122887712;8266.04940431858;8267.917320826835;8298.128696486903;8496.830063398698;8556.101609331055;4700.177468942921;4739.857804265877;4860.4896485869185;4944.60443164546;4954.281629163823;2105.452582328606;2109.673000684896;2117.502386939068;2121.5544735605386;2159.6220661384195;961.4327546747453;966.9661561845302;967.6922082378151;974.6296407365156;993.6025589764153;19835.404937851887;20464.283750068975;21085.472863178544;21119;21164.153433862473;985.8866230383454;989.1938070472542;991.3209451525584;994.3884511025811;1010.282699283517;11086.501107450023;11545.538178472934;11597.76804463906;11688.357140357191;11804.763904721858;515377;521178;524269;530494;611825;102518;104857.47571262247;105183;106094.46952765342;107265;1045.163868904873;1049.6693541534391;1057.629829559648;1068.5885933915342;1073.935563866155;17871.642567148323;17929;18490.537736556693;18675.533111672317;18684.626307474045;43488.78255608702;44866.327005095605;46011;46551.301730473395;47731.28403073887;63901;64655.67672161609;69358.65320673364;69803;70191.29808701847;6573.934260657524;8733.956330218309;9124.817503649758;9185.448873067637;9246.907530924605;8390.874136887829;10931.508082136164;11310.830337545109;14598.175228096488;14661.706765864836;12379.442925068213;12771.4444216766;12870.485180592672;12939.417726202531;13021.414036368576;12505.56230531927;12508.687282818002;12532.624021279376;12582.05634577392;13058.608241752383;12563.246205227715;12976.35118244065;13012.544560940321;13079.607611771662;13203.933980330037;8923.553822308728;8950.546889719726;9064.41444120622;9266.305027122859;9344.766380840261;12343.69140771488;12878.742425151631;12924.870751292367;12969.805452918024;13048.086633935533 14:54:19 INFO - PROCESS | 3397 | |3;mootools.html;1328.0637150808682;1451.8693317601414;1478.91126532408;1484.9183294918778;1488.0104730354315;7521.398288136949;8325.583720813958;8634.050254472018;8656.091110433408;8758.167974042455;8585.356098292637;8635.481871087739;8644.481331120138;8658;8661.437006594568;2039.1129858511522;2120.1201501376986;2315.131825565413;2337.4039619896903;2341.356127065054;2349.6710460535537;2424.6363045543135;2430.0279888044747;2451.240115564172;2453.2272334214754;2393.664886915833;2404.95190096198;2412.493376390951;2416.226807421626;2416.637504374349;2372.074890792592;2373.299876536426;2394.724606670238;2395.413123784684;2397.4605713714363;2317.3743089365944;2328.359701082199;2333.7316208636053;2341.3678306857223;2380.5595964746576;8723.956380218058;8734.51960142192;8790.51652159131;8799.736007919773;8804.64781408743;5232.319798426218;5359.115745901921;5379.327584051994;5388.892222155574;5392.460753924615;3367.2592029753414;3400.8152908837815;3485.0067730696883;3529.4529347951107;3548.556430446194;1338.3508998135994;1377.1943413103347;1393.6655202751367;1459.6642772162463;1462.0861961274204;11966.880331196751;12010.618778840459;12021.579244726392;12033.458494367687;12043.879561204363;4758.952410475851;4771.06964141989;4816.397950256218;4835.95164048362;4916.70499770015;10492.26554141218;10508.632197873038;10517.15862730995;10521;10522.789544209072;5475.835724928259;5478.58910581708;5482.23248745176;5482.972585137049;5484.2047903053835;4898.093852637274;4923.8276660316715;4966.950330496648;4989.725565093882;5011.548960593491;4091.4272001919753;4092.315013085886;4137.462129923151;4222.894427639334;4332.956670433318;1302.5441095616648;1325.648703093681;1327.077681011707;1331.8867896228735;1352.3441131051432;815.657423881971;823.5593957232852;832.9791755206169;835.9707410240612;837.5226121110908;5685;5690.943090569124;5713.085906254979;5830.679312637845;5945.405459454107;560.6103757888228;569.683825476856;569.9544036477155;570.4523657288966;571.459970328036;3763.2661630981697;3827.6746476549806;3837.5394952605866;3877.166409222031;3932.4494570760116;9729;10204.489775511194;10220.131288840532;10273.280870339004;10291.794164116676;9974.251931105196;10023.799524009479;10142;10175.389476631426;10202.132818710492;7873.763787086282;7923;7969.840603187904;7977.162397948248;7998.160193179749;5350.839474815762;5419.34967803866;5501.174823776306;5521.337439507124;5574.554035677217;9049.954750226207;9216.539173041456;9228.446293222429;9324.813503730024;9330.160285574331;9201.815963680823;9406.1064198901;9504.04959504044;9529.475878826453;9603.087706667855;7294.452916031425;7305.1599066105955;7307.196208416964;7388.261173882784;7393.8151546211775;7913.248241417056;8070.47541909774;8073.111957684532;8084.110747817853;8084.231997960184;7248.130224373109;7365.079365079365;7403.370713489414;7426.071741032371;7567;7099.183593886769;7111.111111111111;7141.464390170654;7227.602481863548;7260.4554658399775;6644.966775166094;6670.232923213893;6705.161854768154;6716.5634233774645;6725;5049.359127457981;5097.668651537638;5113.463086376026;5196.480351964773;5254.527092561688;5095.796168153232;5148.150555158357;5189.506996835295;5276.103062479465;5317.175837745156 14:54:19 INFO - PROCESS | 3397 | |4;prototype.html;397.27695594018877;397.4693783798628;403.28215775918875;406.692946825147;407.84705735349223;5312.264183945266;5344.652597581155;5350.839474815757;5383.650062745919;5387.811426600069;4780.784864681089;5198.544407565878;5218.425973142951;5309.73451327434;5320.255164277004;4147.3571596402535;4153.148604536078;4156.8960775980695;4159.085001299724;4172.97913510432;4167.2082304362075;4176.561461046592;4176.853810116647;4182.749035057891;4199.055212577161;4054.513458384998;4161.729487583298;4189.53366321788;4194.475690538683;4196.006896724062;4113.210753322314;4139.172165566899;4148.543660197376;4149.813258403379;4160.7087503874745;3764.5106136202394;3765.3787125124322;3774.245150969817;3782.1868298315994;3787.280416720814;5158.226266060084;5164.6642968207325;5184.144616138333;5197.596648904774;5205.958808238367;4465.799039043251;4655.371524844137;4696.966667333181;4711.269753188261;4711.316859055452;5511.311086114236;5524.33707955044;5525.723713814334;5535.806246781383;5549.916751248735;3987.2623564640344;3991.2416640838437;4011.538673052607;4012.558618551957;4027.9194416111804;5497.532709719639;5514.255575497336;5637.577181711347;5741.971290143522;5772.595918285721;3913.2173565287057;3921.4117882317883;3924.3524818405212;3936.3111455495173;3998.4002399639703;4055.4930633670792;4077.612626800449;4081;4099.754014759124;4109.301418758818;4586.770661466913;4717.669763116549;4719.83480578185;4731.52684731531;4740.478547359788;5577.27495425592;5601.663900166003;5614.354349249807;5630.634008789416;5631.18347839561;1376.7590671632424;1378.8069670246173;1381.2817334985953;1388.4723804954256;1399.069618703571;918.990249969144;944.2964991081689;958.8465845464692;962.5187406296851;966.9516524173763;5114.718690471986;5127.589792816566;5150.871228219249;5179.663321884141;5198.766055527511;5454.7272636368025;5455.18172274162;5477.589180811455;5534.861628459321;5563.304586926634;5072.568831649277;5196.194589838581;5204.739763011834;5221.817236396784;5262.421133675292;2933.6626287977156;2946.941061178807;2951.896683616063;2958.7189217024347;2971.8811247549856;5651.802186923438;5692.829215123553;5753.683547404849;5774.928675283914;5790.942090579125;5341.946580534222;5486.890262194814;5570.916436253459;5574.9721251393485;5609.382967873531;5666.235058267163;5666.611680138392;5670.971645141748;5696.889106624169;5715.48560629537;5212.635115541876;5478.260434841405;5515.187254500153;5527.50757295536;5538.501534861882;5429.326353960042;5432.972835135799;5437.619366644297;5437.755301011385;5462.535684466865;5579.2746942897165;5604;5660.54715622741;5697.259356283656;5744.281964754406;4026.6778657706727;4065.410515475299;4066.8169932352525;4068.3083875740604;4077.7145599808914;5672.376038635664;5673.801416950387;5685.60200785941;5695.117256825199;5695.291412576128;5270.762815673381;5490.835274941758;5554.666719996813;5556.277683901067;5563.721813909369;5519.889602207853;5565.332160140809;5565.6920623652595;5566.415526369835;5573.637713548606;5386.649867758583;5553.77848860459;5579.326202139423;5583.804566840141;5591.916121258266;5564.1931919870585;5574.937273208939;5585.078462053878;5597.860053498695;5599.860003499782;5416.891662166813;5424.918626220689;5426.321709786277;5466.90661867636;5468.179773033918 14:54:19 INFO - PROCESS | 3397 | |5;yui.html;766.8082979255187;800.6077022259095;809.7206463770001;882.7440042387708;909.0818273543719;15982.680346393065;16159.333709937846;16497.917510412448;16684.74972875408;16975.83024169758;15137.772933406008;15231.086134831918;15385.692286154299;15426.537203883874;15599.1420471874;647.9060536222245;666.2804171494774;738.298616314502;750.2460027672182;753.5779963220587;736.517580984456;760.9695612175507;765.5024234247728;765.9617019149048;766.0156698642246;793.8213901872061;795.1253621016893;795.5346122518333;795.7891158842912;795.9005124359455;675.3719041291597;698.6332175607846;790.3756032734133;790.4664351562701;790.5019837502365;567.6253672576121;580.5790801668799;580.7647902599454;582.1994757208838;582.3797655496883;15715.449959251486;15738.527844164693;15793.92103039489;15937.282822273026;15946.681066378724;12861.67845803853;13307.20156790586;13509.662258443519;13656.726865462735;13928.233947132903;13279.46882124714;13338.266395348252;13398.064999726968;13526.526571570046;13558;3870.4968354114067;3969.98015009926;4568.337591049312;4653.86038418848;4662.137504561667;79354.60322698408;80516;81816.59091704563;82062.58968705118;82078.58960705159;11860.703482413008;12078.21491603043;12136.817947730791;12287.1399002069;12300.384980750927;22865.657015144785;22898.084076636747;23122.3063308101;23194.188203413138;23395.88302058513;8195.549244791475;8241.79395515105;8333.541655209021;8394.706185283485;8518.957405212934;4514.25514790056;4587.174308624413;4644.001539668988;4650.00024994621;4698.859034228979;3838.788866612363;3931;3935.8819235422984;3941.1132495188353;3943.408488726714;670.7887015590073;671.7917445591883;675.2403546010738;686.4371215603157;687.5015613680042;790.4032455496064;794.7973266816924;818.7011740714715;829.340674164029;847.9364047696447;10381.688549343531;10841.053012036362;10862.45687715611;11116.777664446667;11268.436578171058;758.3705524414722;766.1160104334865;774.1871035412794;775.3603277296253;778.9571573563509;4985.90028199434;5064.215046667772;5065.438560601115;5121.206213036985;5161.612879034087;78950.6052469734;79217.60391198122;79619.60190199011;80469.59765201136;81542;68410;68727;69096;69787.30212697909;71134.9329760054;60276.698616506634;60530.39469605336;60731;61406.38593614096;62233.066504002476;9522.761930951781;9602;9910.851337229804;9913.256505761952;9936.503174841084;41577;42059.369109463994;42478.1504369917;42735;43015.78492107645;49460.75269623629;51902.48097518976;52327.47672523226;52830.471695282555;52977.7351113242;11687.474063666985;12303;12449.93775031119;12526.311052892179;12759.170653907466;14108.36512356926;14131.364088616243;14274.928625356806;14334.49829255971;14363.928180359031;12819.679508012374;12881.291528965998;12956.28740419286;12963.15739476931;13038.54365097255;12910.741785164057;13227.20636761759;13321.800172997218;13347.799783003456;13577.456901723821;13381.464741410235;13417.798733019208;13476.865231347952;13493.595192144252;14039.368228429541;10489.318194317346;10966.326280696056;11167.776644467227;11199.21605487608;11441.370724610226;10871.945640271748;11058;11088.33469991803;11123.27698699582;11182.496787644413 14:54:19 INFO - PROCESS | 3397 | __end_tp_report 14:54:19 INFO - PROCESS | 3397 | __start_cc_report 14:54:19 INFO - PROCESS | 3397 | _x_x_mozilla_cycle_collect,1125 14:54:19 INFO - PROCESS | 3397 | __end_cc_report 14:54:19 INFO - PROCESS | 3397 | __startTimestamp1484520859959__endTimestamp 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | ------- Summary: start ------- 14:54:19 INFO - PROCESS | 3397 | Number of tests: 6 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | [#0] dojo.html Cycles:165 Average:5292.55 Median:5495.40 stddev:589.63 (10.7%) stddev-sans-first:566.70 14:54:19 INFO - PROCESS | 3397 | Values: 3137.9 3162.8 3180.2 3185.4 3187.7 5131.7 5199.9 5257.0 5260.6 5314.9 5365.3 5375.2 5388.4 5420.1 5464.5 4739.8 4803.9 4826.1 4828.7 4843.7 4924.1 4950.5 4958.7 4963.7 4976.4 4644.7 4671.8 4672.6 4870.7 4890.6 4726.0 4739.5 4742.9 4743.3 4749.1 4692.9 4703.2 4706.0 4712.5 4726.1 5190.0 5225.4 5229.8 5230.3 5235.1 5578.8 5614.2 5615.7 5621.9 5622.8 5567.7 5654.5 5663.7 5666.8 5672.7 5196.2 5236.7 5242.6 5247.9 5254.9 5732.7 5733.3 5736.6 5739.1 5783.2 5401.1 5427.6 5428.8 5498.3 5528.5 5633.4 5636.6 5638.6 5642.5 5647.0 5586.3 5680.3 5701.6 5717.8 5806.2 5731.5 5735.7 5752.4 5752.8 5761.1 4485.8 4491.2 4507.8 4510.7 4544.0 3890.8 3913.7 3983.1 3986.3 3997.0 5483.6 5489.7 5490.9 5492.6 5532.3 5778.9 5817.7 5822.1 5826.8 5831.2 5235.6 5270.7 5280.4 5431.9 5495.4 4882.3 4904.5 4907.5 4940.9 4985.6 5856.6 5869.0 5917.5 5925.2 5927.3 5480.9 5654.9 5666.0 5667.0 5673.8 5691.4 5727.5 5785.2 5790.3 5792.3 5483.9 5493.3 5581.5 5650.4 5697.1 5836.5 5843.3 5848.4 5867.2 5891.4 5695.8 5708.4 5708.9 5709.1 5711.4 5451.0 5500.2 5653.7 5688.1 5709.0 5667.8 5674.1 5699.5 5707.9 5715.0 5600.7 5667.1 5685.8 5686.6 5689.5 5283.9 5316.5 5554.1 5557.2 5561.2 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | [#1] ext.html Cycles:180 Average:57865.44 Median:39255.11 stddev:106324.98 (270.9%) stddev-sans-first:106536.14 14:54:19 INFO - PROCESS | 3397 | Values: 542.7 570.8 605.6 615.9 665.6 35325.8 45276.0 46102.8 46122.8 46271.3 47463.1 47910.8 48006.0 48015.3 48017.3 8482.7 8702.9 8980.0 9163.5 9168.7 10687.9 11007.2 11016.7 11410.3 11414.3 10501.2 10537.8 10556.4 10560.3 10562.4 10942.7 10990.6 11003.9 11005.6 11015.6 10828.8 10883.3 10894.3 10903.7 10909.4 45110.8 45255.1 45308.8 45349.8 45409.8 4302.3 4340.5 4388.6 4434.1 4528.9 32909.5 33524.0 33573.8 33672.5 35026.3 4321.5 4365.5 4366.0 4403.0 4431.3 343066.0 343185.0 343981.0 344393.0 346289.0 64124.4 64416.7 64496.4 64999.7 65050.0 59470.0 59549.0 59676.7 59803.7 59980.4 16370.3 16395.9 16408.8 16435.3 17317.8 12029.5 12290.8 12669.8 12711.2 12985.1 18899.8 18970.1 18975.7 19039.5 19056.8 6335.4 6361.3 6374.8 6470.4 6520.8 954.8 963.5 975.1 976.6 977.1 30863.0 33191.7 33192.3 33192.5 33472.7 1047.0 1125.4 1132.3 1152.8 1157.0 16408.4 16806.9 17001.9 17143.7 17154.7 467560.0 469156.0 471719.0 471955.0 472000.0 62474.4 63088.0 63340.4 63405.0 63463.7 1430.1 1466.6 1466.7 1470.0 1499.9 30539.4 32429.4 32845.7 33001.5 33049.8 53414.0 55154.0 55212.7 55232.7 55278.9 383095.0 385863.0 386525.0 386575.0 387714.0 35938.0 38184.0 41972.6 42123.2 42366.4 46246.5 46702.3 47390.8 47855.3 48943.0 39233.2 39277.0 39385.6 39670.6 41497.4 39029.0 39570.2 39657.0 39739.2 41060.2 38571.2 39583.2 39782.0 40199.6 40282.6 31985.4 33865.2 34351.7 34952.3 35095.8 26431.3 26526.6 26688.6 26708.0 26836.7 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | [#2] jquery.html Cycles:180 Average:31844.23 Median:12179.29 stddev:89719.50 (736.7%) stddev-sans-first:89940.11 14:54:19 INFO - PROCESS | 3397 | Values: 390.8 400.2 419.8 428.9 433.2 20545.3 20708.9 21055.5 21075.2 21377.7 20788.8 21016.0 21066.8 21181.9 21303.7 5654.7 5879.3 5884.5 5896.5 5903.3 5647.4 5789.1 5792.2 5815.2 5845.2 5791.4 5794.6 5796.2 5799.2 5800.5 5781.6 5875.6 6106.0 6123.4 6227.4 5864.7 6035.8 6088.8 6089.8 6091.5 14472.3 14709.4 14761.5 14789.6 21694.6 2664.0 2781.9 2880.6 2889.3 2975.8 10589.8 10698.4 10791.0 11212.8 11299.6 1915.3 1952.6 1968.0 2003.5 2025.9 92156.5 97124.5 98098.0 98751.0 100784.5 11360.7 11702.2 11721.2 11775.6 11776.2 15935.2 15945.6 15956.4 15994.9 16031.3 8356.2 8513.5 8632.8 8857.1 8877.1 8266.0 8267.9 8298.1 8496.8 8556.1 4700.2 4739.9 4860.5 4944.6 4954.3 2105.5 2109.7 2117.5 2121.6 2159.6 961.4 967.0 967.7 974.6 993.6 19835.4 20464.3 21085.5 21119.0 21164.2 985.9 989.2 991.3 994.4 1010.3 11086.5 11545.5 11597.8 11688.4 11804.8 515377.0 521178.0 524269.0 530494.0 611825.0 102518.0 104857.5 105183.0 106094.5 107265.0 1045.2 1049.7 1057.6 1068.6 1073.9 17871.6 17929.0 18490.5 18675.5 18684.6 43488.8 44866.3 46011.0 46551.3 47731.3 63901.0 64655.7 69358.7 69803.0 70191.3 6573.9 8734.0 9124.8 9185.4 9246.9 8390.9 10931.5 11310.8 14598.2 14661.7 12379.4 12771.4 12870.5 12939.4 13021.4 12505.6 12508.7 12532.6 12582.1 13058.6 12563.2 12976.4 13012.5 13079.6 13203.9 8923.6 8950.5 9064.4 9266.3 9344.8 12343.7 12878.7 12924.9 12969.8 13048.1 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | [#3] mootools.html Cycles:180 Average:5635.90 Median:5243.42 stddev:3117.27 (59.5%) stddev-sans-first:3109.20 14:54:19 INFO - PROCESS | 3397 | Values: 1328.1 1451.9 1478.9 1484.9 1488.0 7521.4 8325.6 8634.1 8656.1 8758.2 8585.4 8635.5 8644.5 8658.0 8661.4 2039.1 2120.1 2315.1 2337.4 2341.4 2349.7 2424.6 2430.0 2451.2 2453.2 2393.7 2405.0 2412.5 2416.2 2416.6 2372.1 2373.3 2394.7 2395.4 2397.5 2317.4 2328.4 2333.7 2341.4 2380.6 8724.0 8734.5 8790.5 8799.7 8804.6 5232.3 5359.1 5379.3 5388.9 5392.5 3367.3 3400.8 3485.0 3529.5 3548.6 1338.4 1377.2 1393.7 1459.7 1462.1 11966.9 12010.6 12021.6 12033.5 12043.9 4759.0 4771.1 4816.4 4836.0 4916.7 10492.3 10508.6 10517.2 10521.0 10522.8 5475.8 5478.6 5482.2 5483.0 5484.2 4898.1 4923.8 4967.0 4989.7 5011.5 4091.4 4092.3 4137.5 4222.9 4333.0 1302.5 1325.6 1327.1 1331.9 1352.3 815.7 823.6 833.0 836.0 837.5 5685.0 5690.9 5713.1 5830.7 5945.4 560.6 569.7 570.0 570.5 571.5 3763.3 3827.7 3837.5 3877.2 3932.4 9729.0 10204.5 10220.1 10273.3 10291.8 9974.3 10023.8 10142.0 10175.4 10202.1 7873.8 7923.0 7969.8 7977.2 7998.2 5350.8 5419.3 5501.2 5521.3 5574.6 9050.0 9216.5 9228.4 9324.8 9330.2 9201.8 9406.1 9504.0 9529.5 9603.1 7294.5 7305.2 7307.2 7388.3 7393.8 7913.2 8070.5 8073.1 8084.1 8084.2 7248.1 7365.1 7403.4 7426.1 7567.0 7099.2 7111.1 7141.5 7227.6 7260.5 6645.0 6670.2 6705.2 6716.6 6725.0 5049.4 5097.7 5113.5 5196.5 5254.5 5095.8 5148.2 5189.5 5276.1 5317.2 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | [#4] prototype.html Cycles:180 Average:4628.92 Median:5311.00 stddev:1335.36 (25.1%) stddev-sans-first:1300.78 14:54:19 INFO - PROCESS | 3397 | Values: 397.3 397.5 403.3 406.7 407.8 5312.3 5344.7 5350.8 5383.7 5387.8 4780.8 5198.5 5218.4 5309.7 5320.3 4147.4 4153.1 4156.9 4159.1 4173.0 4167.2 4176.6 4176.9 4182.7 4199.1 4054.5 4161.7 4189.5 4194.5 4196.0 4113.2 4139.2 4148.5 4149.8 4160.7 3764.5 3765.4 3774.2 3782.2 3787.3 5158.2 5164.7 5184.1 5197.6 5206.0 4465.8 4655.4 4697.0 4711.3 4711.3 5511.3 5524.3 5525.7 5535.8 5549.9 3987.3 3991.2 4011.5 4012.6 4027.9 5497.5 5514.3 5637.6 5742.0 5772.6 3913.2 3921.4 3924.4 3936.3 3998.4 4055.5 4077.6 4081.0 4099.8 4109.3 4586.8 4717.7 4719.8 4731.5 4740.5 5577.3 5601.7 5614.4 5630.6 5631.2 1376.8 1378.8 1381.3 1388.5 1399.1 919.0 944.3 958.8 962.5 967.0 5114.7 5127.6 5150.9 5179.7 5198.8 5454.7 5455.2 5477.6 5534.9 5563.3 5072.6 5196.2 5204.7 5221.8 5262.4 2933.7 2946.9 2951.9 2958.7 2971.9 5651.8 5692.8 5753.7 5774.9 5790.9 5341.9 5486.9 5570.9 5575.0 5609.4 5666.2 5666.6 5671.0 5696.9 5715.5 5212.6 5478.3 5515.2 5527.5 5538.5 5429.3 5433.0 5437.6 5437.8 5462.5 5579.3 5604.0 5660.5 5697.3 5744.3 4026.7 4065.4 4066.8 4068.3 4077.7 5672.4 5673.8 5685.6 5695.1 5695.3 5270.8 5490.8 5554.7 5556.3 5563.7 5519.9 5565.3 5565.7 5566.4 5573.6 5386.6 5553.8 5579.3 5583.8 5591.9 5564.2 5574.9 5585.1 5597.9 5599.9 5416.9 5424.9 5426.3 5466.9 5468.2 14:54:19 INFO - PROCESS | 3397 | 14:54:19 INFO - PROCESS | 3397 | [#5] yui.html Cycles:180 Average:17715.17 Median:4647.00 stddev:22436.41 (482.8%) stddev-sans-first:22463.25 14:54:19 INFO - PROCESS | 3397 | Values: 766.8 800.6 809.7 882.7 909.1 15982.7 16159.3 16497.9 16684.7 16975.8 15137.8 15231.1 15385.7 15426.5 15599.1 647.9 666.3 738.3 750.2 753.6 736.5 761.0 765.5 766.0 766.0 793.8 795.1 795.5 795.8 795.9 675.4 698.6 790.4 790.5 790.5 567.6 580.6 580.8 582.2 582.4 15715.4 15738.5 15793.9 15937.3 15946.7 12861.7 13307.2 13509.7 13656.7 13928.2 13279.5 13338.3 13398.1 13526.5 13558.0 3870.5 3970.0 4568.3 4653.9 4662.1 79354.6 80516.0 81816.6 82062.6 82078.6 11860.7 12078.2 12136.8 12287.1 12300.4 22865.7 22898.1 23122.3 23194.2 23395.9 8195.5 8241.8 8333.5 8394.7 8519.0 4514.3 4587.2 4644.0 4650.0 4698.9 3838.8 3931.0 3935.9 3941.1 3943.4 670.8 671.8 675.2 686.4 687.5 790.4 794.8 818.7 829.3 847.9 10381.7 10841.1 10862.5 11116.8 11268.4 758.4 766.1 774.2 775.4 779.0 4985.9 5064.2 5065.4 5121.2 5161.6 78950.6 79217.6 79619.6 80469.6 81542.0 68410.0 68727.0 69096.0 69787.3 71134.9 60276.7 60530.4 60731.0 61406.4 62233.1 9522.8 9602.0 9910.9 9913.3 9936.5 41577.0 42059.4 42478.2 42735.0 43015.8 49460.8 51902.5 52327.5 52830.5 52977.7 11687.5 12303.0 12449.9 12526.3 12759.2 14108.4 14131.4 14274.9 14334.5 14363.9 12819.7 12881.3 12956.3 12963.2 13038.5 12910.7 13227.2 13321.8 13347.8 13577.5 13381.5 13417.8 13476.9 13493.6 14039.4 10489.3 10966.3 11167.8 11199.2 11441.4 10871.9 11058.0 11088.3 11123.3 11182.5 14:54:19 INFO - PROCESS | 3397 | -------- Summary: end -------- 14:54:19 INFO - PROCESS | 3397 | 14:54:20 INFO - TEST-INFO | 3397: exit 0 14:54:20 INFO - TEST-OK | dromaeo_css | took 1117000ms 14:54:20 INFO - TEST-START | kraken 14:54:20 INFO - operating with platform_type : linux_ 14:54:20 INFO - Initialising browser for kraken test... 14:54:20 INFO - TEST-INFO | started process 3698 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpaW4L6E/profile http://localhost:43465/getInfo.html) 14:54:24 INFO - PROCESS | 3698 | __metrics Screen width/height:1600/1200 14:54:24 INFO - PROCESS | 3698 | colorDepth:24 14:54:24 INFO - PROCESS | 3698 | Browser inner width/height: 1024/697 14:54:24 INFO - PROCESS | 3698 | __metrics 14:54:25 INFO - PROCESS | 3698 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 14:54:25 INFO - PROCESS | 3698 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:54:25 INFO - PROCESS | 3698 | console.error: PushService: 14:54:25 INFO - PROCESS | 3698 | stateChangeProcessEnqueue: Error transitioning state 14:54:25 INFO - PROCESS | 3698 | UnknownError 14:54:26 INFO - TEST-INFO | 3698: exit 0 14:54:26 INFO - Browser initialized. 14:54:26 INFO - Running cycle 1/1 for kraken test... 14:54:26 INFO - TEST-INFO | started process 3782 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpaW4L6E/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:54:38 INFO - PROCESS | 3782 | RSS: Main: 147640320 14:54:38 INFO - PROCESS | 3782 | 14:54:40 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:43465/tests/kraken/driver.html?testName=audio-beat-detection) 14:54:41 INFO - PROCESS | 3782 | RSS: Main: 202248192 14:54:41 INFO - PROCESS | 3782 | 14:54:44 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:43465/tests/kraken/driver.html?testName=audio-dft) 14:54:44 INFO - PROCESS | 3782 | RSS: Main: 182493184 14:54:44 INFO - PROCESS | 3782 | 14:54:47 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:43465/tests/kraken/driver.html?testName=audio-fft) 14:54:48 INFO - PROCESS | 3782 | RSS: Main: 263938048 14:54:48 INFO - PROCESS | 3782 | 14:54:50 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:43465/tests/kraken/driver.html?testName=audio-oscillator) 14:54:50 INFO - PROCESS | 3782 | RSS: Main: 175915008 14:54:50 INFO - PROCESS | 3782 | 14:54:53 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:43465/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:54:53 INFO - PROCESS | 3782 | RSS: Main: 179236864 14:54:53 INFO - PROCESS | 3782 | 14:54:56 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:43465/tests/kraken/driver.html?testName=imaging-darkroom) 14:54:57 INFO - PROCESS | 3782 | RSS: Main: 218988544 14:54:57 INFO - PROCESS | 3782 | 14:55:00 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:43465/tests/kraken/driver.html?testName=imaging-desaturate) 14:55:01 INFO - PROCESS | 3782 | RSS: Main: 218030080 14:55:01 INFO - PROCESS | 3782 | 14:55:03 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:43465/tests/kraken/driver.html?testName=json-parse-financial) 14:55:04 INFO - PROCESS | 3782 | RSS: Main: 216690688 14:55:04 INFO - PROCESS | 3782 | 14:55:06 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:43465/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:55:06 INFO - PROCESS | 3782 | RSS: Main: 179503104 14:55:06 INFO - PROCESS | 3782 | 14:55:08 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:55:09 INFO - PROCESS | 3782 | RSS: Main: 186187776 14:55:09 INFO - PROCESS | 3782 | 14:55:11 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:55:12 INFO - PROCESS | 3782 | RSS: Main: 195309568 14:55:12 INFO - PROCESS | 3782 | 14:55:14 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:55:15 INFO - PROCESS | 3782 | RSS: Main: 204582912 14:55:15 INFO - PROCESS | 3782 | 14:55:18 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:55:19 INFO - PROCESS | 3782 | RSS: Main: 200343552 14:55:19 INFO - PROCESS | 3782 | 14:55:20 INFO - PROCESS | 3782 | Cycle 1(1): loaded http://localhost:43465/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:43465/tests/kraken/driver.html?testName=ai-astar) 14:55:21 INFO - PROCESS | 3782 | RSS: Main: 252157952 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | __start_tp_report 14:55:21 INFO - PROCESS | 3782 | _x_x_mozilla_page_load 14:55:21 INFO - PROCESS | 3782 | _x_x_mozilla_page_load_details 14:55:21 INFO - PROCESS | 3782 | |i|pagename|runs| 14:55:21 INFO - PROCESS | 3782 | |0;ai-astar;108;111;111;110;110;111;110;112;112;110 14:55:21 INFO - PROCESS | 3782 | |1;audio-beat-detection;153;118;120;161;124;121;121;122;140;118 14:55:21 INFO - PROCESS | 3782 | |2;audio-dft;161;160;160;160;159;161;161;161;162;161 14:55:21 INFO - PROCESS | 3782 | |3;audio-fft;74;75;75;110;76;75;75;76;94;74 14:55:21 INFO - PROCESS | 3782 | |4;audio-oscillator;83;82;113;83;84;83;94;84;82;114 14:55:21 INFO - PROCESS | 3782 | |5;imaging-gaussian-blur;117;116;117;117;117;117;117;117;117;118 14:55:21 INFO - PROCESS | 3782 | |6;imaging-darkroom;147;147;146;146;147;147;146;146;146;148 14:55:21 INFO - PROCESS | 3782 | |7;imaging-desaturate;96;97;97;95;95;95;96;96;95;96 14:55:21 INFO - PROCESS | 3782 | |8;json-parse-financial;52;52;58;52;52;55;53;53;52;52 14:55:21 INFO - PROCESS | 3782 | |9;json-stringify-tinderbox;67;70;67;68;68;67;67;68;68;68 14:55:21 INFO - PROCESS | 3782 | |10;stanford-crypto-aes;83;81;90;84;82;82;83;82;83;87 14:55:21 INFO - PROCESS | 3782 | |11;stanford-crypto-ccm;127;127;129;133;133;132;131;140;159;125 14:55:21 INFO - PROCESS | 3782 | |12;stanford-crypto-pbkdf2;176;178;174;174;173;176;173;178;177;172 14:55:21 INFO - PROCESS | 3782 | |13;stanford-crypto-sha256-iterative;65;62;64;63;65;67;63;63;63;63 14:55:21 INFO - PROCESS | 3782 | __end_tp_report 14:55:21 INFO - PROCESS | 3782 | __start_cc_report 14:55:21 INFO - PROCESS | 3782 | _x_x_mozilla_cycle_collect,1545 14:55:21 INFO - PROCESS | 3782 | __end_cc_report 14:55:21 INFO - PROCESS | 3782 | __startTimestamp1484520921109__endTimestamp 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | ------- Summary: start ------- 14:55:21 INFO - PROCESS | 3782 | Number of tests: 14 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#0] ai-astar Cycles:10 Average:110.50 Median:111.00 stddev:1.18 (1.1%) stddev-sans-first:0.83 14:55:21 INFO - PROCESS | 3782 | Values: 108.0 111.0 111.0 110.0 110.0 111.0 110.0 112.0 112.0 110.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#1] audio-beat-detection Cycles:10 Average:129.80 Median:123.00 stddev:15.77 (12.8%) stddev-sans-first:14.32 14:55:21 INFO - PROCESS | 3782 | Values: 153.0 118.0 120.0 161.0 124.0 121.0 121.0 122.0 140.0 118.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#2] audio-dft Cycles:10 Average:160.60 Median:161.00 stddev:0.84 (0.5%) stddev-sans-first:0.88 14:55:21 INFO - PROCESS | 3782 | Values: 161.0 160.0 160.0 160.0 159.0 161.0 161.0 161.0 162.0 161.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#3] audio-fft Cycles:10 Average:80.40 Median:75.00 stddev:12.01 (16.0%) stddev-sans-first:12.51 14:55:21 INFO - PROCESS | 3782 | Values: 74.0 75.0 75.0 110.0 76.0 75.0 75.0 76.0 94.0 74.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#4] audio-oscillator Cycles:10 Average:90.20 Median:83.00 stddev:12.77 (15.4%) stddev-sans-first:13.28 14:55:21 INFO - PROCESS | 3782 | Values: 83.0 82.0 113.0 83.0 84.0 83.0 94.0 84.0 82.0 114.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.47 (0.4%) stddev-sans-first:0.50 14:55:21 INFO - PROCESS | 3782 | Values: 117.0 116.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 118.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#6] imaging-darkroom Cycles:10 Average:146.60 Median:147.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 14:55:21 INFO - PROCESS | 3782 | Values: 147.0 147.0 146.0 146.0 147.0 147.0 146.0 146.0 146.0 148.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.79 (0.8%) stddev-sans-first:0.83 14:55:21 INFO - PROCESS | 3782 | Values: 96.0 97.0 97.0 95.0 95.0 95.0 96.0 96.0 95.0 96.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#8] json-parse-financial Cycles:10 Average:53.10 Median:52.50 stddev:1.97 (3.8%) stddev-sans-first:2.05 14:55:21 INFO - PROCESS | 3782 | Values: 52.0 52.0 58.0 52.0 52.0 55.0 53.0 53.0 52.0 52.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#9] json-stringify-tinderbox Cycles:10 Average:67.80 Median:68.00 stddev:0.92 (1.4%) stddev-sans-first:0.93 14:55:21 INFO - PROCESS | 3782 | Values: 67.0 70.0 67.0 68.0 68.0 67.0 67.0 68.0 68.0 68.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#10] stanford-crypto-aes Cycles:10 Average:83.70 Median:83.00 stddev:2.75 (3.3%) stddev-sans-first:2.91 14:55:21 INFO - PROCESS | 3782 | Values: 83.0 81.0 90.0 84.0 82.0 82.0 83.0 82.0 83.0 87.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#11] stanford-crypto-ccm Cycles:10 Average:133.60 Median:132.50 stddev:9.88 (7.5%) stddev-sans-first:10.19 14:55:21 INFO - PROCESS | 3782 | Values: 127.0 127.0 129.0 133.0 133.0 132.0 131.0 140.0 159.0 125.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:175.10 Median:176.00 stddev:2.18 (1.2%) stddev-sans-first:2.29 14:55:21 INFO - PROCESS | 3782 | Values: 176.0 178.0 174.0 174.0 173.0 176.0 173.0 178.0 177.0 172.0 14:55:21 INFO - PROCESS | 3782 | 14:55:21 INFO - PROCESS | 3782 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.80 Median:63.50 stddev:1.48 (2.3%) stddev-sans-first:1.50 14:55:21 INFO - PROCESS | 3782 | Values: 65.0 62.0 64.0 63.0 65.0 67.0 63.0 63.0 63.0 63.0 14:55:21 INFO - PROCESS | 3782 | -------- Summary: end -------- 14:55:21 INFO - PROCESS | 3782 | 14:55:22 INFO - TEST-INFO | 3782: exit 0 14:55:22 INFO - TEST-OK | kraken | took 61435ms 14:55:22 INFO - SUITE-END | took 1178s 14:55:22 INFO - Completed test suite (00:19:38) 14:55:22 INFO - javascript benchmark 14:55:22 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3137.8744850205994, 3162.794418362808, 3180.1890517917927, 3185.4106990206815, 3187.7449804015682, 5131.743412829363, 5199.934013527227, 5257.0011697777445, 5260.552853007494, 5314.867128321789, 5365.275687782138, 5375.247465354853, 5388.43421440749, 5420.051490989081, 5464.453554644533, 4739.810407583693, 4803.855884323476, 4826.083044221604, 4828.71027738335, 4843.66094373394, 4924.138275801721, 4950.529699678525, 4958.727270000149, 4963.7021778693215, 4976.402831660206, 4644.674872758908, 4671.766411679402, 4672.579467847876, 4870.732109733964, 4890.584300334476, 4726.0, 4739.454962679301, 4742.881427964294, 4743.335932969387, 4749.097671442415, 4692.882677933045, 4703.2474804031535, 4705.976470117662, 4712.505186955389, 4726.102040612307, 5190.0, 5225.399079105876, 5229.790808367698, 5230.293910322096, 5235.057689615867, 5578.804741834017, 5614.214010038598, 5615.719214039282, 5621.887562248732, 5622.775088996435, 5567.693776842272, 5654.491095801356, 5663.66018038919, 5666.829995100154, 5672.68800215988, 5196.220566914955, 5236.73816309183, 5242.60680448964, 5247.895042099175, 5254.947450525522, 5732.713364331767, 5733.283339582552, 5736.569757268138, 5739.081746920473, 5783.19035335045, 5401.081816091274, 5427.6200665953, 5428.75570599324, 5498.340199176125, 5528.530074943595, 5633.4084921082695, 5636.60543761941, 5638.633488823213, 5642.548596112301, 5647.0, 5586.273784408001, 5680.261565996477, 5701.572382071361, 5717.771289148387, 5806.21616081832, 5731.455511726379, 5735.713214339266, 5752.424757524214, 5752.827415177551, 5761.0782274836665, 4485.820567177341, 4491.169133710274, 4507.774611269489, 4510.684252102387, 4544.0457503924545, 3890.824912878927, 3913.7064720146104, 3983.14362412077, 3986.3023970804993, 3997.0, 5483.588730845203, 5489.725513724298, 5490.890182196414, 5492.5605951523785, 5532.30846144232, 5778.913316300259, 5817.650940943472, 5822.0975748758165, 5826.82519524415, 5831.154482599999, 5235.607329450307, 5270.70724234959, 5280.419153893069, 5431.891362172813, 5495.395506494282, 4882.340883980617, 4904.509549045067, 4907.484714105039, 4940.90118197634, 4985.5762260208285, 5856.648601083949, 5868.9706551467825, 5917.497012753878, 5925.200097986716, 5927.2590926134235, 5480.91778623313, 5654.943450565442, 5666.0, 5666.9716651416475, 5673.8297851064535, 5691.373948865538, 5727.4845263926445, 5785.190073389645, 5790.305163380422, 5792.333881603501, 5483.862903427446, 5493.285872836505, 5581.5255703265675, 5650.434956504481, 5697.145428185805, 5836.503897168788, 5843.2695913010875, 5848.385919478394, 5867.20792692981, 5891.410858914074, 5695.800646977336, 5708.429157084258, 5708.885822283448, 5709.115087161496, 5711.428857114422, 5451.046066938191, 5500.22996780459, 5653.717314134195, 5688.089905615082, 5709.0, 5667.829965101054, 5674.120511320752, 5699.487046165865, 5707.857303567444, 5715.028445164249, 5600.719964001865, 5667.093265077568, 5685.829425117253, 5686.60193786431, 5689.459501347365, 5283.920741188808, 5316.521513063843, 5554.055810512142, 5557.194206839905, 5561.249231353715], "value": 5254.218527534786, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [542.7420873070901, 570.7945139749689, 605.560968297984, 615.947644450222, 665.5840099937539, 35325.82337088314, 45276.0, 46102.7694861526, 46122.76938615311, 46271.30593041103, 47463.05073898529, 47910.760446197804, 48006.0, 48015.27977080346, 48017.27974080392, 8482.660693572281, 8702.912970870273, 8980.012198658158, 9163.450192988443, 9168.724938251864, 10687.893121068768, 11007.174461915389, 11016.724581885437, 11410.31538107712, 11414.258073225255, 10501.212409069312, 10537.841932370982, 10556.366618002907, 10560.31357961734, 10562.419066951315, 10942.726431839188, 10990.560377584927, 11003.889961100447, 11005.61480348184, 11015.559377624886, 10828.837567436494, 10883.292585981964, 10894.291871028357, 10903.727406814814, 10909.399983000932, 45110.77444612756, 45255.09489810185, 45308.773456132505, 45349.77325113386, 45409.77295113536, 4302.26861433557, 4340.479142502888, 4388.561143885618, 4434.06884554244, 4528.909421811578, 32909.50635740466, 33524.0, 33573.83213083919, 33672.49491257633, 35026.29947401063, 4321.481422229353, 4365.5416181300825, 4366.0, 4402.977985110086, 4431.290993441034, 343066.0, 343185.0, 343981.0, 344393.0, 346289.0, 64124.358756412774, 64416.67791661012, 64496.35503644904, 64999.67500162469, 65050.0, 59470.0, 59549.0, 59676.70161649164, 59803.700981495684, 59980.40019599835, 16370.345186192419, 16395.918020409823, 16408.75386869198, 16435.342586296414, 17317.82682173162, 12029.458674359676, 12290.75418491643, 12669.809952850715, 12711.173773704679, 12985.091043626855, 18899.81100189008, 18970.14634341458, 18975.71536426955, 19039.52401189981, 19056.809431905782, 6335.36646335372, 6361.300256971729, 6374.776882809079, 6470.352964703586, 6520.8373938639725, 954.8233576788316, 963.4797209506928, 975.068809287129, 976.5507866381544, 977.0815433492494, 30863.0, 33191.66808331886, 33192.336153276796, 33192.50211246833, 33472.66527334695, 1046.9633562825265, 1125.4260327233005, 1132.2753437799815, 1152.815549512074, 1156.9595064172713, 16408.425705100504, 16806.91596542034, 17001.914990424968, 17143.657126857393, 17154.656906861794, 467560.0, 469156.0, 471719.0, 471955.0, 472000.0, 62474.37525624777, 63088.0, 63340.36659633437, 63405.0, 63463.68268158722, 1430.1304059676818, 1466.6213759066443, 1466.7286551987704, 1469.9706005879823, 1499.9475018374305, 30539.38921221519, 32429.351412971137, 32845.67154328426, 33001.50497742584, 33049.83475082609, 53414.0, 55154.0, 55212.72393638167, 55232.72383638056, 55278.894422112135, 383095.0, 385863.0, 386525.0, 386575.0, 387714.0, 35938.0, 38184.0, 41972.580274196866, 42123.15753684971, 42366.36450453184, 46246.53753462422, 46702.299465508724, 47390.76304618593, 47855.28217076677, 48943.0, 39233.2153356937, 39277.0, 39385.60614393934, 39670.60329396669, 41497.37753933633, 39029.02427439337, 39570.208595827346, 39657.0, 39739.2052158961, 41060.17879642331, 38571.2285754289, 39583.2083358337, 39782.00544986399, 40199.59800401959, 40282.597174027884, 31985.36029279355, 33865.15337116592, 34351.65648343485, 34952.300953981285, 35095.824520877235, 26431.33921651974, 26526.571346129003, 26688.599671004562, 26708.0, 26836.731632683423], "value": 20845.325794241213, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [390.822175909961, 400.175638185338, 419.7901049475261, 428.93994840722297, 433.2375019964861, 20545.280915167972, 20708.896455517737, 21055.47361315968, 21075.156993720233, 21377.67933480997, 20788.792112078914, 21016.0, 21066.789332106673, 21181.894090529564, 21303.680444793303, 5654.660720356782, 5879.294484661847, 5884.499817515495, 5896.528277737792, 5903.26209223847, 5647.3505546862025, 5789.131630255453, 5792.160136780164, 5815.185873977646, 5845.210896528978, 5791.362950075489, 5794.565407594426, 5796.188533605298, 5799.246098007253, 5800.506956908668, 5781.566382521307, 5875.588708790387, 6106.0, 6123.418275263887, 6227.377262273736, 5864.736086876058, 6035.8305864544955, 6088.786892458743, 6089.786857460012, 6091.451769340736, 14472.348744306531, 14709.411623535047, 14761.483348082873, 14789.630259243497, 21694.566108677896, 2664.004990642545, 2781.916542503728, 2880.5967164596973, 2889.306566424064, 2975.821450712964, 10589.84115238272, 10698.411587362692, 10791.0, 11212.831807522894, 11299.604513841976, 1915.3296346278692, 1952.6094781043848, 1967.9704804427945, 2003.4690806936173, 2025.9392218233477, 92156.53921730416, 97124.51437742836, 98098.0, 98751.0, 100784.49607751914, 11360.715982100513, 11702.239354441934, 11721.186915140304, 11775.646730598095, 11776.234544754563, 15935.203239837962, 15945.601359966093, 15956.361745530048, 15994.920025399799, 16031.278592463366, 8356.247937685515, 8513.489190648581, 8632.78418039554, 8857.11428857109, 8877.1122887712, 8266.04940431858, 8267.917320826835, 8298.128696486903, 8496.830063398698, 8556.101609331055, 4700.177468942921, 4739.857804265877, 4860.4896485869185, 4944.60443164546, 4954.281629163823, 2105.452582328606, 2109.673000684896, 2117.502386939068, 2121.5544735605386, 2159.6220661384195, 961.4327546747453, 966.9661561845302, 967.6922082378151, 974.6296407365156, 993.6025589764153, 19835.404937851887, 20464.283750068975, 21085.472863178544, 21119.0, 21164.153433862473, 985.8866230383454, 989.1938070472542, 991.3209451525584, 994.3884511025811, 1010.282699283517, 11086.501107450023, 11545.538178472934, 11597.76804463906, 11688.357140357191, 11804.763904721858, 515377.0, 521178.0, 524269.0, 530494.0, 611825.0, 102518.0, 104857.47571262247, 105183.0, 106094.46952765342, 107265.0, 1045.163868904873, 1049.6693541534391, 1057.629829559648, 1068.5885933915342, 1073.935563866155, 17871.642567148323, 17929.0, 18490.537736556693, 18675.533111672317, 18684.626307474045, 43488.78255608702, 44866.327005095605, 46011.0, 46551.301730473395, 47731.28403073887, 63901.0, 64655.67672161609, 69358.65320673364, 69803.0, 70191.29808701847, 6573.934260657524, 8733.956330218309, 9124.817503649758, 9185.448873067637, 9246.907530924605, 8390.874136887829, 10931.508082136164, 11310.830337545109, 14598.175228096488, 14661.706765864836, 12379.442925068213, 12771.4444216766, 12870.485180592672, 12939.417726202531, 13021.414036368576, 12505.56230531927, 12508.687282818002, 12532.624021279376, 12582.05634577392, 13058.608241752383, 12563.246205227715, 12976.35118244065, 13012.544560940321, 13079.607611771662, 13203.933980330037, 8923.553822308728, 8950.546889719726, 9064.41444120622, 9266.305027122859, 9344.766380840261, 12343.69140771488, 12878.742425151631, 12924.870751292367, 12969.805452918024, 13048.086633935533], "value": 9709.333604230138, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1328.0637150808682, 1451.8693317601414, 1478.91126532408, 1484.9183294918778, 1488.0104730354315, 7521.398288136949, 8325.583720813958, 8634.050254472018, 8656.091110433408, 8758.167974042455, 8585.356098292637, 8635.481871087739, 8644.481331120138, 8658.0, 8661.437006594568, 2039.1129858511522, 2120.1201501376986, 2315.131825565413, 2337.4039619896903, 2341.356127065054, 2349.6710460535537, 2424.6363045543135, 2430.0279888044747, 2451.240115564172, 2453.2272334214754, 2393.664886915833, 2404.95190096198, 2412.493376390951, 2416.226807421626, 2416.637504374349, 2372.074890792592, 2373.299876536426, 2394.724606670238, 2395.413123784684, 2397.4605713714363, 2317.3743089365944, 2328.359701082199, 2333.7316208636053, 2341.3678306857223, 2380.5595964746576, 8723.956380218058, 8734.51960142192, 8790.51652159131, 8799.736007919773, 8804.64781408743, 5232.319798426218, 5359.115745901921, 5379.327584051994, 5388.892222155574, 5392.460753924615, 3367.2592029753414, 3400.8152908837815, 3485.0067730696883, 3529.4529347951107, 3548.556430446194, 1338.3508998135994, 1377.1943413103347, 1393.6655202751367, 1459.6642772162463, 1462.0861961274204, 11966.880331196751, 12010.618778840459, 12021.579244726392, 12033.458494367687, 12043.879561204363, 4758.952410475851, 4771.06964141989, 4816.397950256218, 4835.95164048362, 4916.70499770015, 10492.26554141218, 10508.632197873038, 10517.15862730995, 10521.0, 10522.789544209072, 5475.835724928259, 5478.58910581708, 5482.23248745176, 5482.972585137049, 5484.2047903053835, 4898.093852637274, 4923.8276660316715, 4966.950330496648, 4989.725565093882, 5011.548960593491, 4091.4272001919753, 4092.315013085886, 4137.462129923151, 4222.894427639334, 4332.956670433318, 1302.5441095616648, 1325.648703093681, 1327.077681011707, 1331.8867896228735, 1352.3441131051432, 815.657423881971, 823.5593957232852, 832.9791755206169, 835.9707410240612, 837.5226121110908, 5685.0, 5690.943090569124, 5713.085906254979, 5830.679312637845, 5945.405459454107, 560.6103757888228, 569.683825476856, 569.9544036477155, 570.4523657288966, 571.459970328036, 3763.2661630981697, 3827.6746476549806, 3837.5394952605866, 3877.166409222031, 3932.4494570760116, 9729.0, 10204.489775511194, 10220.131288840532, 10273.280870339004, 10291.794164116676, 9974.251931105196, 10023.799524009479, 10142.0, 10175.389476631426, 10202.132818710492, 7873.763787086282, 7923.0, 7969.840603187904, 7977.162397948248, 7998.160193179749, 5350.839474815762, 5419.34967803866, 5501.174823776306, 5521.337439507124, 5574.554035677217, 9049.954750226207, 9216.539173041456, 9228.446293222429, 9324.813503730024, 9330.160285574331, 9201.815963680823, 9406.1064198901, 9504.04959504044, 9529.475878826453, 9603.087706667855, 7294.452916031425, 7305.1599066105955, 7307.196208416964, 7388.261173882784, 7393.8151546211775, 7913.248241417056, 8070.47541909774, 8073.111957684532, 8084.110747817853, 8084.231997960184, 7248.130224373109, 7365.079365079365, 7403.370713489414, 7426.071741032371, 7567.0, 7099.183593886769, 7111.111111111111, 7141.464390170654, 7227.602481863548, 7260.4554658399775, 6644.966775166094, 6670.232923213893, 6705.161854768154, 6716.5634233774645, 6725.0, 5049.359127457981, 5097.668651537638, 5113.463086376026, 5196.480351964773, 5254.527092561688, 5095.796168153232, 5148.150555158357, 5189.506996835295, 5276.103062479465, 5317.175837745156], "value": 4513.705150940193, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [397.27695594018877, 397.4693783798628, 403.28215775918875, 406.692946825147, 407.84705735349223, 5312.264183945266, 5344.652597581155, 5350.839474815757, 5383.650062745919, 5387.811426600069, 4780.784864681089, 5198.544407565878, 5218.425973142951, 5309.73451327434, 5320.255164277004, 4147.3571596402535, 4153.148604536078, 4156.8960775980695, 4159.085001299724, 4172.97913510432, 4167.2082304362075, 4176.561461046592, 4176.853810116647, 4182.749035057891, 4199.055212577161, 4054.513458384998, 4161.729487583298, 4189.53366321788, 4194.475690538683, 4196.006896724062, 4113.210753322314, 4139.172165566899, 4148.543660197376, 4149.813258403379, 4160.7087503874745, 3764.5106136202394, 3765.3787125124322, 3774.245150969817, 3782.1868298315994, 3787.280416720814, 5158.226266060084, 5164.6642968207325, 5184.144616138333, 5197.596648904774, 5205.958808238367, 4465.799039043251, 4655.371524844137, 4696.966667333181, 4711.269753188261, 4711.316859055452, 5511.311086114236, 5524.33707955044, 5525.723713814334, 5535.806246781383, 5549.916751248735, 3987.2623564640344, 3991.2416640838437, 4011.538673052607, 4012.558618551957, 4027.9194416111804, 5497.532709719639, 5514.255575497336, 5637.577181711347, 5741.971290143522, 5772.595918285721, 3913.2173565287057, 3921.4117882317883, 3924.3524818405212, 3936.3111455495173, 3998.4002399639703, 4055.4930633670792, 4077.612626800449, 4081.0, 4099.754014759124, 4109.301418758818, 4586.770661466913, 4717.669763116549, 4719.83480578185, 4731.52684731531, 4740.478547359788, 5577.27495425592, 5601.663900166003, 5614.354349249807, 5630.634008789416, 5631.18347839561, 1376.7590671632424, 1378.8069670246173, 1381.2817334985953, 1388.4723804954256, 1399.069618703571, 918.990249969144, 944.2964991081689, 958.8465845464692, 962.5187406296851, 966.9516524173763, 5114.718690471986, 5127.589792816566, 5150.871228219249, 5179.663321884141, 5198.766055527511, 5454.7272636368025, 5455.18172274162, 5477.589180811455, 5534.861628459321, 5563.304586926634, 5072.568831649277, 5196.194589838581, 5204.739763011834, 5221.817236396784, 5262.421133675292, 2933.6626287977156, 2946.941061178807, 2951.896683616063, 2958.7189217024347, 2971.8811247549856, 5651.802186923438, 5692.829215123553, 5753.683547404849, 5774.928675283914, 5790.942090579125, 5341.946580534222, 5486.890262194814, 5570.916436253459, 5574.9721251393485, 5609.382967873531, 5666.235058267163, 5666.611680138392, 5670.971645141748, 5696.889106624169, 5715.48560629537, 5212.635115541876, 5478.260434841405, 5515.187254500153, 5527.50757295536, 5538.501534861882, 5429.326353960042, 5432.972835135799, 5437.619366644297, 5437.755301011385, 5462.535684466865, 5579.2746942897165, 5604.0, 5660.54715622741, 5697.259356283656, 5744.281964754406, 4026.6778657706727, 4065.410515475299, 4066.8169932352525, 4068.3083875740604, 4077.7145599808914, 5672.376038635664, 5673.801416950387, 5685.60200785941, 5695.117256825199, 5695.291412576128, 5270.762815673381, 5490.835274941758, 5554.666719996813, 5556.277683901067, 5563.721813909369, 5519.889602207853, 5565.332160140809, 5565.6920623652595, 5566.415526369835, 5573.637713548606, 5386.649867758583, 5553.77848860459, 5579.326202139423, 5583.804566840141, 5591.916121258266, 5564.1931919870585, 5574.937273208939, 5585.078462053878, 5597.860053498695, 5599.860003499782, 5416.891662166813, 5424.918626220689, 5426.321709786277, 5466.90661867636, 5468.179773033918], "value": 4221.533706742452, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [766.8082979255187, 800.6077022259095, 809.7206463770001, 882.7440042387708, 909.0818273543719, 15982.680346393065, 16159.333709937846, 16497.917510412448, 16684.74972875408, 16975.83024169758, 15137.772933406008, 15231.086134831918, 15385.692286154299, 15426.537203883874, 15599.1420471874, 647.9060536222245, 666.2804171494774, 738.298616314502, 750.2460027672182, 753.5779963220587, 736.517580984456, 760.9695612175507, 765.5024234247728, 765.9617019149048, 766.0156698642246, 793.8213901872061, 795.1253621016893, 795.5346122518333, 795.7891158842912, 795.9005124359455, 675.3719041291597, 698.6332175607846, 790.3756032734133, 790.4664351562701, 790.5019837502365, 567.6253672576121, 580.5790801668799, 580.7647902599454, 582.1994757208838, 582.3797655496883, 15715.449959251486, 15738.527844164693, 15793.92103039489, 15937.282822273026, 15946.681066378724, 12861.67845803853, 13307.20156790586, 13509.662258443519, 13656.726865462735, 13928.233947132903, 13279.46882124714, 13338.266395348252, 13398.064999726968, 13526.526571570046, 13558.0, 3870.4968354114067, 3969.98015009926, 4568.337591049312, 4653.86038418848, 4662.137504561667, 79354.60322698408, 80516.0, 81816.59091704563, 82062.58968705118, 82078.58960705159, 11860.703482413008, 12078.21491603043, 12136.817947730791, 12287.1399002069, 12300.384980750927, 22865.657015144785, 22898.084076636747, 23122.3063308101, 23194.188203413138, 23395.88302058513, 8195.549244791475, 8241.79395515105, 8333.541655209021, 8394.706185283485, 8518.957405212934, 4514.25514790056, 4587.174308624413, 4644.001539668988, 4650.00024994621, 4698.859034228979, 3838.788866612363, 3931.0, 3935.8819235422984, 3941.1132495188353, 3943.408488726714, 670.7887015590073, 671.7917445591883, 675.2403546010738, 686.4371215603157, 687.5015613680042, 790.4032455496064, 794.7973266816924, 818.7011740714715, 829.340674164029, 847.9364047696447, 10381.688549343531, 10841.053012036362, 10862.45687715611, 11116.777664446667, 11268.436578171058, 758.3705524414722, 766.1160104334865, 774.1871035412794, 775.3603277296253, 778.9571573563509, 4985.90028199434, 5064.215046667772, 5065.438560601115, 5121.206213036985, 5161.612879034087, 78950.6052469734, 79217.60391198122, 79619.60190199011, 80469.59765201136, 81542.0, 68410.0, 68727.0, 69096.0, 69787.30212697909, 71134.9329760054, 60276.698616506634, 60530.39469605336, 60731.0, 61406.38593614096, 62233.066504002476, 9522.761930951781, 9602.0, 9910.851337229804, 9913.256505761952, 9936.503174841084, 41577.0, 42059.369109463994, 42478.1504369917, 42735.0, 43015.78492107645, 49460.75269623629, 51902.48097518976, 52327.47672523226, 52830.471695282555, 52977.7351113242, 11687.474063666985, 12303.0, 12449.93775031119, 12526.311052892179, 12759.170653907466, 14108.36512356926, 14131.364088616243, 14274.928625356806, 14334.49829255971, 14363.928180359031, 12819.679508012374, 12881.291528965998, 12956.28740419286, 12963.15739476931, 13038.54365097255, 12910.741785164057, 13227.20636761759, 13321.800172997218, 13347.799783003456, 13577.456901723821, 13381.464741410235, 13417.798733019208, 13476.865231347952, 13493.595192144252, 14039.368228429541, 10489.318194317346, 10966.326280696056, 11167.776644467227, 11199.21605487608, 11441.370724610226, 10871.945640271748, 11058.0, 11088.33469991803, 11123.27698699582, 11182.496787644413], "value": 7338.695443382622, "unit": "score"}], "name": "dromaeo_css", "value": 7278.851182500113, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [108.0, 111.0, 111.0, 110.0, 110.0, 111.0, 110.0, 112.0, 112.0, 110.0], "value": 110.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 118.0, 120.0, 161.0, 124.0, 121.0, 121.0, 122.0, 140.0, 118.0], "value": 129.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 160.0, 160.0, 160.0, 159.0, 161.0, 161.0, 161.0, 162.0, 161.0], "value": 160.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 75.0, 75.0, 110.0, 76.0, 75.0, 75.0, 76.0, 94.0, 74.0], "value": 80.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 113.0, 83.0, 84.0, 83.0, 94.0, 84.0, 82.0, 114.0], "value": 90.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 146.0, 146.0, 147.0, 147.0, 146.0, 146.0, 146.0, 148.0], "value": 146.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 97.0, 97.0, 95.0, 95.0, 95.0, 96.0, 96.0, 95.0, 96.0], "value": 95.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 52.0, 58.0, 52.0, 52.0, 55.0, 53.0, 53.0, 52.0, 52.0], "value": 53.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 70.0, 67.0, 68.0, 68.0, 67.0, 67.0, 68.0, 68.0, 68.0], "value": 67.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 81.0, 90.0, 84.0, 82.0, 82.0, 83.0, 82.0, 83.0, 87.0], "value": 83.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 127.0, 129.0, 133.0, 133.0, 132.0, 131.0, 140.0, 159.0, 125.0], "value": 133.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [176.0, 178.0, 174.0, 174.0, 173.0, 176.0, 173.0, 178.0, 177.0, 172.0], "value": 175.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 62.0, 64.0, 63.0, 65.0, 67.0, 63.0, 63.0, 63.0, 63.0], "value": 63.8, "unit": "score"}], "name": "kraken", "value": 1507.9999999999998, "alertThreshold": 2.0}]} 14:55:22 INFO - Return code: 0 14:55:22 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 14:55:22 ERROR - # TBPL SUCCESS # 14:55:22 INFO - Running post-action listener: _resource_record_post_action 14:55:22 INFO - [mozharness: 2017-01-15 22:55:22.405020Z] Finished run-tests step (success) 14:55:22 INFO - Running post-run listener: _resource_record_post_run 14:55:22 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 7962624; Write bytes: 430510080; Read time: 1624; Write time: 359884 14:55:22 INFO - TinderboxPrint: CPU usage
13.1% 14:55:22 INFO - TinderboxPrint: I/O read bytes / time
7,962,624 / 1,624 14:55:22 INFO - TinderboxPrint: I/O write bytes / time
430,510,080 / 359,884 14:55:22 INFO - TinderboxPrint: CPU idle
8,298.3 (86.9%) 14:55:22 INFO - TinderboxPrint: CPU user
1,199.4 (12.6%) 14:55:22 INFO - TinderboxPrint: Swap in / out
0 / 0 14:55:22 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 4096; Write bytes: 64098304; Read time: 220; Write time: 38712 14:55:22 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 5988352; Write bytes: 332136448; Read time: 1116; Write time: 269320 14:55:23 INFO - Running post-run listener: _upload_blobber_files 14:55:23 INFO - Blob upload gear active. 14:55:23 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 14:55:23 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 14:55:23 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', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 14:55:23 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 Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 14:55:23 INFO - (blobuploader) - INFO - Open directory for files ... 14:55:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 14:55:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:55:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:55:24 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 14:55:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:55:24 INFO - (blobuploader) - INFO - Done attempting. 14:55:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 14:55:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:55:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:55:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 14:55:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:55:25 INFO - (blobuploader) - INFO - Done attempting. 14:55:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 14:55:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:55:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:55:26 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 14:55:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:55:26 INFO - (blobuploader) - INFO - Done attempting. 14:55:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 14:55:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:55:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:55:29 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 14:55:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:55:29 INFO - (blobuploader) - INFO - Done attempting. 14:55:29 INFO - (blobuploader) - INFO - Iteration through files over. 14:55:29 INFO - Return code: 0 14:55:29 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 14:55:29 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 14:55:29 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71bd073ece209c84f08b538f6ddb5a65e5a59b10b9466fd3bcff8b1f3b90da50496c41b0d7c89cf68e9d87906463e59140a5c37a73c71dd58d829c8008fc7964", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/ea26ddb107edef850e3c3557859c006ff36f29ebd05aa869f8b19a16da5190dd24555b635e906d2aab443ed3402415057dcf121be08cf17daf8511cf839646b3", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ca1aa018f99a634d35a5c6421c6660b48eff2f744cc61b98cadf5c2a79aef23d9875bfd03bda6b379925f31a45f176cb3a50c9db9a1828e785a08bd9f4d54c3", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/bd52a8d12199def2f3d503e222d5101014fed005ee4d8b174f374facbce79b122596e28ce761b81a9ff7c570611a63291ab6089c0acc55098a7a91c9714d9819"} 14:55:29 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 14:55:29 INFO - Writing to file /builds/slave/test/properties/blobber_files 14:55:29 INFO - Contents: 14:55:29 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71bd073ece209c84f08b538f6ddb5a65e5a59b10b9466fd3bcff8b1f3b90da50496c41b0d7c89cf68e9d87906463e59140a5c37a73c71dd58d829c8008fc7964", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/ea26ddb107edef850e3c3557859c006ff36f29ebd05aa869f8b19a16da5190dd24555b635e906d2aab443ed3402415057dcf121be08cf17daf8511cf839646b3", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ca1aa018f99a634d35a5c6421c6660b48eff2f744cc61b98cadf5c2a79aef23d9875bfd03bda6b379925f31a45f176cb3a50c9db9a1828e785a08bd9f4d54c3", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/bd52a8d12199def2f3d503e222d5101014fed005ee4d8b174f374facbce79b122596e28ce761b81a9ff7c570611a63291ab6089c0acc55098a7a91c9714d9819"} 14:55:29 INFO - Running post-run listener: copy_logs_to_upload_dir 14:55:29 INFO - Copying logs to upload dir... 14:55:29 INFO - mkdir: /builds/slave/test/build/upload/logs 14:55:29 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.652770 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-01-15 14:55:29.396110) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-01-15 14:55:29.399386) ========= 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=652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71bd073ece209c84f08b538f6ddb5a65e5a59b10b9466fd3bcff8b1f3b90da50496c41b0d7c89cf68e9d87906463e59140a5c37a73c71dd58d829c8008fc7964", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/ea26ddb107edef850e3c3557859c006ff36f29ebd05aa869f8b19a16da5190dd24555b635e906d2aab443ed3402415057dcf121be08cf17daf8511cf839646b3", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ca1aa018f99a634d35a5c6421c6660b48eff2f744cc61b98cadf5c2a79aef23d9875bfd03bda6b379925f31a45f176cb3a50c9db9a1828e785a08bd9f4d54c3", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/bd52a8d12199def2f3d503e222d5101014fed005ee4d8b174f374facbce79b122596e28ce761b81a9ff7c570611a63291ab6089c0acc55098a7a91c9714d9819"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011312 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1484512203/firefox-53.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71bd073ece209c84f08b538f6ddb5a65e5a59b10b9466fd3bcff8b1f3b90da50496c41b0d7c89cf68e9d87906463e59140a5c37a73c71dd58d829c8008fc7964", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/ea26ddb107edef850e3c3557859c006ff36f29ebd05aa869f8b19a16da5190dd24555b635e906d2aab443ed3402415057dcf121be08cf17daf8511cf839646b3", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ca1aa018f99a634d35a5c6421c6660b48eff2f744cc61b98cadf5c2a79aef23d9875bfd03bda6b379925f31a45f176cb3a50c9db9a1828e785a08bd9f4d54c3", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/bd52a8d12199def2f3d503e222d5101014fed005ee4d8b174f374facbce79b122596e28ce761b81a9ff7c570611a63291ab6089c0acc55098a7a91c9714d9819"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-01-15 14:55:29.424882) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-01-15 14:55:29.425203) ========= 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=652eb03db935cfc1c15ebda0000001ad-1484516227.612088-624432504 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004357 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-01-15 14:55:29.511370) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-01-15 14:55:29.511761) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-01-15 14:55:29.512076) ========= ========= Total master_lag: 0.16 =========