builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-027 starttime: 1477934843.36 results: success (0) buildid: 20161031073220 builduid: de17d3c5a26b42358e0b407ef8f11342 revision: c28bcbd086c2dc63e18e0b0c8a2ab7dbe0dce373 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.362899) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.363361) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.363646) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.378008) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.378289) ========= 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=1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-31 10:27:23-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 102M=0s 2016-10-31 10:27:23 (102 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.090685 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.482528) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.482836) ========= 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=1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021875 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.532343) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:23.532703) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev c28bcbd086c2dc63e18e0b0c8a2ab7dbe0dce373 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev c28bcbd086c2dc63e18e0b0c8a2ab7dbe0dce373 --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=1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-31 10:27:23,918 truncating revision to first 12 chars 2016-10-31 10:27:23,918 Setting DEBUG logging. 2016-10-31 10:27:23,918 attempt 1/10 2016-10-31 10:27:23,918 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/c28bcbd086c2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-31 10:27:24,237 unpacking tar archive at: mozilla-central-c28bcbd086c2/testing/mozharness/ program finished with exit code 0 elapsedTime=0.669320 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:24.215570) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:24.215870) ========= script_repo_revision: c28bcbd086c2dc63e18e0b0c8a2ab7dbe0dce373 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:24.216669) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:24.216935) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-31 10:27:24.225826) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 40 secs) (at 2016-10-31 10:27:24.226093) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:27:24 INFO - MultiFileLogger online at 20161031 10:27:24 in /builds/slave/test 10:27:24 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 10:27:24 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:27:24 INFO - {'append_to_log': False, 10:27:24 INFO - 'base_work_dir': '/builds/slave/test', 10:27:24 INFO - 'blob_upload_branch': 'Firefox', 10:27:24 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:27:24 INFO - 'branch': 'Firefox', 10:27:24 INFO - 'buildbot_json_path': 'buildprops.json', 10:27:24 INFO - 'config_files': ('talos/linux_config.py',), 10:27:24 INFO - 'default_actions': ('clobber', 10:27:24 INFO - 'read-buildbot-config', 10:27:24 INFO - 'download-and-extract', 10:27:24 INFO - 'populate-webroot', 10:27:24 INFO - 'create-virtualenv', 10:27:24 INFO - 'install', 10:27:24 INFO - 'run-tests'), 10:27:24 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:27:24 INFO - 'download_minidump_stackwalk': True, 10:27:24 INFO - 'download_symbols': 'ondemand', 10:27:24 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:27:24 INFO - 'tooltool.py': '/tools/tooltool.py', 10:27:24 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:27:24 INFO - '/tools/misc-python/virtualenv.py')}, 10:27:24 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:27:24 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:27:24 INFO - 'installer_path': 'installer.exe', 10:27:24 INFO - 'log_level': 'info', 10:27:24 INFO - 'log_name': 'talos', 10:27:24 INFO - 'log_to_console': True, 10:27:24 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:27:24 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:27:24 INFO - 'opt_config_files': (), 10:27:24 INFO - 'pip_index': False, 10:27:24 INFO - 'sps_profile': False, 10:27:24 INFO - 'sps_profile_interval': 0, 10:27:24 INFO - 'suite': 'dromaeojs', 10:27:24 INFO - 'system_bits': '32', 10:27:24 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:27:24 INFO - 'title': 'talos-linux64-ix-027', 10:27:24 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:27:24 INFO - 'use_talos_json': True, 10:27:24 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:27:24 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:27:24 INFO - 'work_dir': 'build'} 10:27:24 INFO - [mozharness: 2016-10-31 17:27:24.703976Z] Running clobber step. 10:27:24 INFO - Running pre-action listener: _resource_record_pre_action 10:27:24 INFO - Running main action method: clobber 10:27:24 INFO - rmtree: /builds/slave/test/build 10:27:24 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:27:25 INFO - Running post-action listener: _resource_record_post_action 10:27:25 INFO - [mozharness: 2016-10-31 17:27:25.169268Z] Finished clobber step (success) 10:27:25 INFO - [mozharness: 2016-10-31 17:27:25.169368Z] Running read-buildbot-config step. 10:27:25 INFO - Running pre-action listener: _resource_record_pre_action 10:27:25 INFO - Running main action method: read_buildbot_config 10:27:25 INFO - Using buildbot properties: 10:27:25 INFO - { 10:27:25 INFO - "project": "", 10:27:25 INFO - "product": "firefox", 10:27:25 INFO - "script_repo_revision": "production", 10:27:25 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 10:27:25 INFO - "repository": "", 10:27:25 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 10:27:25 INFO - "buildid": "20161031073220", 10:27:25 INFO - "pgo_build": "True", 10:27:25 INFO - "basedir": "/builds/slave/test", 10:27:25 INFO - "buildnumber": 607, 10:27:25 INFO - "slavename": "talos-linux64-ix-027", 10:27:25 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 10:27:25 INFO - "platform": "ubuntu64_hw", 10:27:25 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 10:27:25 INFO - "branch": "mozilla-central", 10:27:25 INFO - "repo_path": "mozilla-central", 10:27:25 INFO - "revision": "c28bcbd086c2dc63e18e0b0c8a2ab7dbe0dce373", 10:27:25 INFO - "stage_platform": "linux64-pgo", 10:27:25 INFO - "builduid": "de17d3c5a26b42358e0b407ef8f11342", 10:27:25 INFO - "slavebuilddir": "test" 10:27:25 INFO - } 10:27:25 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 10:27:25 INFO - Running post-action listener: _resource_record_post_action 10:27:25 INFO - [mozharness: 2016-10-31 17:27:25.171831Z] Finished read-buildbot-config step (success) 10:27:25 INFO - [mozharness: 2016-10-31 17:27:25.171921Z] Running download-and-extract step. 10:27:25 INFO - Running pre-action listener: _resource_record_pre_action 10:27:25 INFO - Running main action method: download_and_extract 10:27:25 INFO - mkdir: /builds/slave/test/build/tests 10:27: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')]} 10:27:25 INFO - trying https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 10:27:25 INFO - Downloading https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 10:27:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:27:25 INFO - Downloaded 1361 bytes. 10:27:25 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 10:27:25 INFO - Using the following test package requirements: 10:27:25 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 10:27:25 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:27:25 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:27:25 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'jsshell-linux-x86_64.zip'], 10:27:25 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:27:25 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 10:27:25 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:27:25 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:27:25 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:27:25 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:27:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:27:25 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:27:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 10:27:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:27:25 INFO - Fetch https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 10:27:26 INFO - Http code: 200 10:27:26 INFO - via: 1.1 336f0e6ef9a3462f682d6ca49029b665.cloudfront.net (CloudFront) 10:27:26 INFO - x-amz-cf-id: EOX8EIEAkGbdHFUhLS8T7xpL2AHgK4VgIWS0wZxdqjRxefyqKshybg== 10:27:26 INFO - x-amz-version-id: gVz8a_RiUyazLiqNqrmF6K.G5y_Jmjmn 10:27:26 INFO - Expected file size: 22006828 10:27:26 INFO - Obtained file size: 22006828 10:27:30 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:27:30 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 10:27:30 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:27:30 INFO - Fetch https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 10:27:31 INFO - Http code: 200 10:27:31 INFO - via: 1.1 455cf6ccbccc261c46d02110de1c0237.cloudfront.net (CloudFront) 10:27:31 INFO - x-amz-cf-id: _aeNGFlt_-2a8SdhKcqavHi_WE2mpbI7TN2Qr4G71tXcnpWVM8bUjA== 10:27:31 INFO - x-amz-version-id: gVz8a_RiUyazLiqNqrmF6K.G5y_Jmjmn 10:27:31 INFO - Expected file size: 22006828 10:27:31 INFO - Obtained file size: 22006828 10:27:36 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 10:27:36 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:27:36 INFO - Fetch https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 10:27:36 INFO - Http code: 200 10:27:36 INFO - via: 1.1 0cf1d7257c633ae75623c5e75bf3805e.cloudfront.net (CloudFront) 10:27:36 INFO - x-amz-cf-id: LfEBzauURvJOrv1ycBxRTVmF46q5s2BmU2F4n6b5_UVIQzpTB5TsmQ== 10:27:36 INFO - x-amz-version-id: mwNDxKuxPgmh5Q2wHUrOrY1Nzh4_LcBa 10:27:37 INFO - Expected file size: 14409038 10:27:37 INFO - Obtained file size: 14409038 10:27:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:27:37 INFO - trying https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:27:37 INFO - Downloading https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:27:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:27:39 INFO - Downloaded 59626243 bytes. 10:27:39 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:27:39 INFO - mkdir: /builds/slave/test/properties 10:27:39 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:27:39 INFO - Writing to file /builds/slave/test/properties/build_url 10:27:39 INFO - Contents: 10:27:39 INFO - build_url:https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:27:39 INFO - Running post-action listener: _resource_record_post_action 10:27:39 INFO - Running post-action listener: set_extra_try_arguments 10:27:39 INFO - [mozharness: 2016-10-31 17:27:39.806389Z] Finished download-and-extract step (success) 10:27:39 INFO - [mozharness: 2016-10-31 17:27:39.806617Z] Running populate-webroot step. 10:27:39 INFO - Running pre-action listener: _resource_record_pre_action 10:27:39 INFO - Running main action method: populate_webroot 10:27:39 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:27:39 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:27:39 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:27:39 INFO - '--tppagecycles', 10:27:39 INFO - '7'], 10:27:39 INFO - 'tests': ['tsvgm']}}, 10:27:39 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:27:39 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:27:39 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:27:39 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:27:39 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:27:39 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:27:39 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['damp', 'tps']}, 10:27:39 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'tests': ['damp', 'tps']}, 10:27:39 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['dromaeo_dom']}, 10:27:39 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:27:39 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['basic_compositor_video']}, 10:27:39 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:27:39 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['a11yr', 10:27:39 INFO - 'ts_paint', 10:27:39 INFO - 'tpaint', 10:27:39 INFO - 'sessionrestore', 10:27:39 INFO - 'sessionrestore_no_auto_restore', 10:27:39 INFO - 'tabpaint']}, 10:27:39 INFO - 'other-e10s': {'tests': ['a11yr', 10:27:39 INFO - 'ts_paint', 10:27:39 INFO - 'tpaint', 10:27:39 INFO - 'sessionrestore', 10:27:39 INFO - 'sessionrestore_no_auto_restore', 10:27:39 INFO - 'tabpaint']}, 10:27:39 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:27:39 INFO - 'ts_paint', 10:27:39 INFO - 'tpaint', 10:27:39 INFO - 'sessionrestore', 10:27:39 INFO - 'sessionrestore_no_auto_restore', 10:27:39 INFO - 'tabpaint']}, 10:27:39 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:27:39 INFO - 'ts_paint', 10:27:39 INFO - 'tpaint', 10:27:39 INFO - 'sessionrestore', 10:27:39 INFO - 'sessionrestore_no_auto_restore', 10:27:39 INFO - 'tabpaint']}, 10:27:39 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['a11yr', 10:27:39 INFO - 'ts_paint', 10:27:39 INFO - 'tpaint', 10:27:39 INFO - 'sessionrestore', 10:27:39 INFO - 'sessionrestore_no_auto_restore', 10:27:39 INFO - 'tabpaint']}, 10:27:39 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['a11yr', 10:27:39 INFO - 'ts_paint', 10:27:39 INFO - 'tpaint', 10:27:39 INFO - 'sessionrestore', 10:27:39 INFO - 'sessionrestore_no_auto_restore', 10:27:39 INFO - 'tabpaint']}, 10:27:39 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['tsvgx', 10:27:39 INFO - 'tsvgr_opacity', 10:27:39 INFO - 'tart', 10:27:39 INFO - 'tscrollx', 10:27:39 INFO - 'cart']}, 10:27:39 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:27:39 INFO - 'tsvgr_opacity', 10:27:39 INFO - 'tart', 10:27:39 INFO - 'tscrollx', 10:27:39 INFO - 'cart']}, 10:27:39 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'talos_options': ['--disable-e10s'], 10:27:39 INFO - 'tests': ['tp5o']}, 10:27:39 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'tests': ['tp5o']}, 10:27:39 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'talos_options': ['--disable-e10s', 10:27:39 INFO - '--xperf_path', 10:27:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:27:39 INFO - 'tests': ['tp5n']}, 10:27:39 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:27:39 INFO - 'talos_options': ['--xperf_path', 10:27:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:27:39 INFO - 'tests': ['tp5n']}}, 10:27:39 INFO - 'talos.zip': {'path': '', 10:27:39 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:27:39 INFO - Running post-action listener: _resource_record_post_action 10:27:39 INFO - [mozharness: 2016-10-31 17:27:39.828126Z] Finished populate-webroot step (success) 10:27:39 INFO - [mozharness: 2016-10-31 17:27:39.828215Z] Running create-virtualenv step. 10:27:39 INFO - Running pre-action listener: _resource_record_pre_action 10:27:39 INFO - Running main action method: create_virtualenv 10:27:39 INFO - Creating virtualenv /builds/slave/test/build/venv 10:27:39 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 10:27:39 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:27:39 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:27:39 INFO - Using real prefix '/usr' 10:27:39 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:27:40 INFO - Installing distribute.............................................................................................................................................................................................done. 10:27:42 INFO - Installing pip.................done. 10:27:42 INFO - Return code: 0 10:27:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 10:27:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 10:27:42 INFO - Reading from file tmpfile_stdout 10:27:42 INFO - Output received: 10:27:42 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) 10:27:42 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:27: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')]} 10:27:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27: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')]} 10:27:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 10:27:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 10:27:42 INFO - Using env: {'DISPLAY': ':0', 10:27:42 INFO - 'HOME': '/home/cltbld', 10:27:42 INFO - 'LANG': 'en_US.UTF-8', 10:27:42 INFO - 'LANGUAGE': 'en_US:en', 10:27:42 INFO - 'LOGNAME': 'cltbld', 10:27:42 INFO - 'MAIL': '/var/mail/cltbld', 10:27:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:42 INFO - 'MOZ_NO_REMOTE': '1', 10:27:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:42 INFO - 'NO_EM_RESTART': '1', 10:27:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:42 INFO - 'PWD': '/builds/slave/test', 10:27:42 INFO - 'SHELL': '/bin/bash', 10:27:42 INFO - 'SHLVL': '1', 10:27:42 INFO - 'TERM': 'linux', 10:27:42 INFO - 'TMOUT': '86400', 10:27:42 INFO - 'USER': 'cltbld', 10:27:42 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:42 INFO - '_': '/tools/buildbot/bin/python'} 10:27:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:42 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 10:27:42 INFO - Cleaning up... 10:27:42 INFO - Return code: 0 10:27:42 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:27: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')]} 10:27:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27: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')]} 10:27:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 10:27:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 10:27:42 INFO - Using env: {'DISPLAY': ':0', 10:27:42 INFO - 'HOME': '/home/cltbld', 10:27:42 INFO - 'LANG': 'en_US.UTF-8', 10:27:42 INFO - 'LANGUAGE': 'en_US:en', 10:27:42 INFO - 'LOGNAME': 'cltbld', 10:27:42 INFO - 'MAIL': '/var/mail/cltbld', 10:27:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:42 INFO - 'MOZ_NO_REMOTE': '1', 10:27:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:42 INFO - 'NO_EM_RESTART': '1', 10:27:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:42 INFO - 'PWD': '/builds/slave/test', 10:27:42 INFO - 'SHELL': '/bin/bash', 10:27:42 INFO - 'SHLVL': '1', 10:27:42 INFO - 'TERM': 'linux', 10:27:42 INFO - 'TMOUT': '86400', 10:27:42 INFO - 'USER': 'cltbld', 10:27:42 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:42 INFO - '_': '/tools/buildbot/bin/python'} 10:27:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:43 INFO - Downloading/unpacking psutil>=3.1.1 10:27:43 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 10:27:43 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 10:27:43 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 10:27:43 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 10:27:43 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 10:27:43 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 10:27:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:27:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:27:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:27:45 INFO - Installing collected packages: psutil 10:27:45 INFO - Running setup.py install for psutil 10:27:45 INFO - building 'psutil._psutil_linux' extension 10:27:45 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 10:27:45 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 10:27:45 INFO - building 'psutil._psutil_posix' extension 10:27:45 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 10:27:45 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 10:27:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:27:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:27:45 INFO - Successfully installed psutil 10:27:45 INFO - Cleaning up... 10:27:45 INFO - Return code: 0 10:27:45 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:27:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:27:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:27:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:45 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:45 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 10:27:45 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 10:27:45 INFO - Using env: {'DISPLAY': ':0', 10:27:45 INFO - 'HOME': '/home/cltbld', 10:27:45 INFO - 'LANG': 'en_US.UTF-8', 10:27:45 INFO - 'LANGUAGE': 'en_US:en', 10:27:45 INFO - 'LOGNAME': 'cltbld', 10:27:45 INFO - 'MAIL': '/var/mail/cltbld', 10:27:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:45 INFO - 'MOZ_NO_REMOTE': '1', 10:27:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:45 INFO - 'NO_EM_RESTART': '1', 10:27:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:45 INFO - 'PWD': '/builds/slave/test', 10:27:45 INFO - 'SHELL': '/bin/bash', 10:27:45 INFO - 'SHLVL': '1', 10:27:45 INFO - 'TERM': 'linux', 10:27:45 INFO - 'TMOUT': '86400', 10:27:45 INFO - 'USER': 'cltbld', 10:27:45 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:45 INFO - '_': '/tools/buildbot/bin/python'} 10:27:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:45 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:27:45 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 10:27:45 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 10:27:45 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 10:27:45 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 10:27:45 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 10:27:45 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 10:27:47 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:27:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:27:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:27:47 INFO - Installing collected packages: mozsystemmonitor 10:27:47 INFO - Running setup.py install for mozsystemmonitor 10:27:47 INFO - Successfully installed mozsystemmonitor 10:27:47 INFO - Cleaning up... 10:27:47 INFO - Return code: 0 10:27:47 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:27:47 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')]} 10:27:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:47 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')]} 10:27:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:47 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:47 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 10:27:47 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 10:27:47 INFO - Using env: {'DISPLAY': ':0', 10:27:47 INFO - 'HOME': '/home/cltbld', 10:27:47 INFO - 'LANG': 'en_US.UTF-8', 10:27:47 INFO - 'LANGUAGE': 'en_US:en', 10:27:47 INFO - 'LOGNAME': 'cltbld', 10:27:47 INFO - 'MAIL': '/var/mail/cltbld', 10:27:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:47 INFO - 'MOZ_NO_REMOTE': '1', 10:27:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:47 INFO - 'NO_EM_RESTART': '1', 10:27:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:47 INFO - 'PWD': '/builds/slave/test', 10:27:47 INFO - 'SHELL': '/bin/bash', 10:27:47 INFO - 'SHLVL': '1', 10:27:47 INFO - 'TERM': 'linux', 10:27:47 INFO - 'TMOUT': '86400', 10:27:47 INFO - 'USER': 'cltbld', 10:27:47 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:47 INFO - '_': '/tools/buildbot/bin/python'} 10:27:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:48 INFO - Downloading/unpacking jsonschema==2.5.1 10:27:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:27:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:27:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:27:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:27:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:27:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:27:50 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:27:50 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:27:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:27:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:27:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:27:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:27:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:27:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:27:50 INFO - Downloading functools32-3.2.3-2.tar.gz 10:27:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:27:50 INFO - warning: no files found matching '*.txt' 10:27:50 INFO - no previously-included directories found matching 'build' 10:27:50 INFO - no previously-included directories found matching 'dist' 10:27:50 INFO - no previously-included directories found matching '.git*' 10:27:50 INFO - Installing collected packages: jsonschema, functools32 10:27:50 INFO - Running setup.py install for functools32 10:27:50 INFO - warning: no files found matching '*.txt' 10:27:50 INFO - no previously-included directories found matching 'build' 10:27:50 INFO - no previously-included directories found matching 'dist' 10:27:50 INFO - no previously-included directories found matching '.git*' 10:27:50 INFO - Successfully installed jsonschema functools32 10:27:50 INFO - Cleaning up... 10:27:50 INFO - Return code: 0 10:27:50 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:27:50 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')]} 10:27:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:50 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')]} 10:27:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:50 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:50 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 10:27:50 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 10:27:50 INFO - Using env: {'DISPLAY': ':0', 10:27:50 INFO - 'HOME': '/home/cltbld', 10:27:50 INFO - 'LANG': 'en_US.UTF-8', 10:27:50 INFO - 'LANGUAGE': 'en_US:en', 10:27:50 INFO - 'LOGNAME': 'cltbld', 10:27:50 INFO - 'MAIL': '/var/mail/cltbld', 10:27:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:50 INFO - 'MOZ_NO_REMOTE': '1', 10:27:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:50 INFO - 'NO_EM_RESTART': '1', 10:27:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:50 INFO - 'PWD': '/builds/slave/test', 10:27:50 INFO - 'SHELL': '/bin/bash', 10:27:50 INFO - 'SHLVL': '1', 10:27:50 INFO - 'TERM': 'linux', 10:27:50 INFO - 'TMOUT': '86400', 10:27:50 INFO - 'USER': 'cltbld', 10:27:50 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:50 INFO - '_': '/tools/buildbot/bin/python'} 10:27:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:51 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:27:51 INFO - Cleaning up... 10:27:51 INFO - Return code: 0 10:27:51 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:27:51 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')]} 10:27:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:51 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')]} 10:27:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:51 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:51 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 10:27:51 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 10:27:51 INFO - Using env: {'DISPLAY': ':0', 10:27:51 INFO - 'HOME': '/home/cltbld', 10:27:51 INFO - 'LANG': 'en_US.UTF-8', 10:27:51 INFO - 'LANGUAGE': 'en_US:en', 10:27:51 INFO - 'LOGNAME': 'cltbld', 10:27:51 INFO - 'MAIL': '/var/mail/cltbld', 10:27:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:51 INFO - 'MOZ_NO_REMOTE': '1', 10:27:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:51 INFO - 'NO_EM_RESTART': '1', 10:27:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:51 INFO - 'PWD': '/builds/slave/test', 10:27:51 INFO - 'SHELL': '/bin/bash', 10:27:51 INFO - 'SHLVL': '1', 10:27:51 INFO - 'TERM': 'linux', 10:27:51 INFO - 'TMOUT': '86400', 10:27:51 INFO - 'USER': 'cltbld', 10:27:51 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:51 INFO - '_': '/tools/buildbot/bin/python'} 10:27:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:51 INFO - Downloading/unpacking blobuploader==1.2.4 10:27:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:27:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:27:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:27:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:27:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:27:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:27:53 INFO - Downloading blobuploader-1.2.4.tar.gz 10:27:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:27:53 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:27:53 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 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 10:27:53 INFO - Downloading docopt-0.6.1.tar.gz 10:27:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:27:53 INFO - Installing collected packages: blobuploader, requests, docopt 10:27:53 INFO - Running setup.py install for blobuploader 10:27:53 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:27:54 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:27:54 INFO - Running setup.py install for requests 10:27:54 INFO - Running setup.py install for docopt 10:27:54 INFO - Successfully installed blobuploader requests docopt 10:27:54 INFO - Cleaning up... 10:27:54 INFO - Return code: 0 10:27:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:27:54 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')]} 10:27:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:54 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')]} 10:27:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:54 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:54 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 10:27:54 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 10:27:54 INFO - Using env: {'DISPLAY': ':0', 10:27:54 INFO - 'HOME': '/home/cltbld', 10:27:54 INFO - 'LANG': 'en_US.UTF-8', 10:27:54 INFO - 'LANGUAGE': 'en_US:en', 10:27:54 INFO - 'LOGNAME': 'cltbld', 10:27:54 INFO - 'MAIL': '/var/mail/cltbld', 10:27:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:54 INFO - 'MOZ_NO_REMOTE': '1', 10:27:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:54 INFO - 'NO_EM_RESTART': '1', 10:27:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:54 INFO - 'PWD': '/builds/slave/test', 10:27:54 INFO - 'SHELL': '/bin/bash', 10:27:54 INFO - 'SHLVL': '1', 10:27:54 INFO - 'TERM': 'linux', 10:27:54 INFO - 'TMOUT': '86400', 10:27:54 INFO - 'USER': 'cltbld', 10:27:54 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:54 INFO - '_': '/tools/buildbot/bin/python'} 10:27:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:27:54 INFO - Running setup.py (path:/tmp/pip-vspwr2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:27:54 INFO - Running setup.py (path:/tmp/pip-pReKpk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:27:54 INFO - Running setup.py (path:/tmp/pip-ZkoOld-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:27:54 INFO - Running setup.py (path:/tmp/pip-G62VqY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:27:55 INFO - Running setup.py (path:/tmp/pip-U48OFL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:27:55 INFO - Running setup.py (path:/tmp/pip-WJgSn8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:27:55 INFO - Running setup.py (path:/tmp/pip-zyooV9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:27:55 INFO - Running setup.py (path:/tmp/pip-qgQuc3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:27:55 INFO - Running setup.py (path:/tmp/pip-IEEPmQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:27:55 INFO - Running setup.py (path:/tmp/pip-xR16JK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:27:55 INFO - Running setup.py (path:/tmp/pip-w2S3Uy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:27:55 INFO - Running setup.py (path:/tmp/pip-DYKaD0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:27:55 INFO - Running setup.py (path:/tmp/pip-hsHl4_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:27:55 INFO - Running setup.py (path:/tmp/pip-SsRDuG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:27:55 INFO - Running setup.py (path:/tmp/pip-hGHUzZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:27:55 INFO - Running setup.py (path:/tmp/pip-_E4VBj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:27:55 INFO - Running setup.py (path:/tmp/pip-XTqp5P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:27:55 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:27:55 INFO - Running setup.py install for manifestparser 10:27:56 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Running setup.py install for mozcrash 10:27:56 INFO - Running setup.py install for mozdebug 10:27:56 INFO - Running setup.py install for mozdevice 10:27:56 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Running setup.py install for mozfile 10:27:56 INFO - Running setup.py install for mozhttpd 10:27:56 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Running setup.py install for mozinfo 10:27:56 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Running setup.py install for mozInstall 10:27:56 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:27:56 INFO - Running setup.py install for mozleak 10:27:56 INFO - Running setup.py install for mozlog 10:27:57 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:27:57 INFO - Running setup.py install for moznetwork 10:27:57 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:27:57 INFO - Running setup.py install for mozprocess 10:27:57 INFO - Running setup.py install for mozprofile 10:27:57 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:27:57 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:27:57 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:27:57 INFO - Running setup.py install for mozrunner 10:27:57 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:27:57 INFO - Running setup.py install for mozscreenshot 10:27:57 INFO - Running setup.py install for moztest 10:27:57 INFO - Running setup.py install for mozversion 10:27:57 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:27:57 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:27:57 INFO - Cleaning up... 10:27:57 INFO - Return code: 0 10:27:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:27:57 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')]} 10:27:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:27:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:57 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')]} 10:27:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:27:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:27:57 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:27:57 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 10:27:57 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 10:27:57 INFO - Using env: {'DISPLAY': ':0', 10:27:57 INFO - 'HOME': '/home/cltbld', 10:27:57 INFO - 'LANG': 'en_US.UTF-8', 10:27:57 INFO - 'LANGUAGE': 'en_US:en', 10:27:57 INFO - 'LOGNAME': 'cltbld', 10:27:57 INFO - 'MAIL': '/var/mail/cltbld', 10:27:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:27:57 INFO - 'MOZ_NO_REMOTE': '1', 10:27:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:27:57 INFO - 'NO_EM_RESTART': '1', 10:27:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:27:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:27:57 INFO - 'PWD': '/builds/slave/test', 10:27:57 INFO - 'SHELL': '/bin/bash', 10:27:57 INFO - 'SHLVL': '1', 10:27:57 INFO - 'TERM': 'linux', 10:27:57 INFO - 'TMOUT': '86400', 10:27:57 INFO - 'USER': 'cltbld', 10:27:57 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:27:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:27:57 INFO - '_': '/tools/buildbot/bin/python'} 10:27:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:27:58 INFO - Running setup.py (path:/tmp/pip-0xarDQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:27:58 INFO - Running setup.py (path:/tmp/pip-zvnBec-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:27:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:27:58 INFO - Running setup.py (path:/tmp/pip-J3nMsH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:27:58 INFO - Running setup.py (path:/tmp/pip-yy3MVI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:27:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:27:58 INFO - Running setup.py (path:/tmp/pip-Rn9A8b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:27:58 INFO - Running setup.py (path:/tmp/pip-P3OJeC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:27:58 INFO - Running setup.py (path:/tmp/pip-Gc9ani-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:27:58 INFO - Running setup.py (path:/tmp/pip-FXXezs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:27:58 INFO - Running setup.py (path:/tmp/pip-r4wZFm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:27:58 INFO - Running setup.py (path:/tmp/pip-FQ7WKp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:27:58 INFO - Running setup.py (path:/tmp/pip-_YBtUq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:27:58 INFO - Running setup.py (path:/tmp/pip-RnKobi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:27:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:27:58 INFO - Running setup.py (path:/tmp/pip-mZouVE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:27:58 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)) 10:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:27:58 INFO - Running setup.py (path:/tmp/pip-TP8c3g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:27:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 10:27:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:27:59 INFO - Running setup.py (path:/tmp/pip-VApp4Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:27:59 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)) 10:27:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:27:59 INFO - Running setup.py (path:/tmp/pip-thCLJD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:27:59 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 10:27:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:27:59 INFO - Running setup.py (path:/tmp/pip-rR__xc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:27:59 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)) 10:27:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:27:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:27:59 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)) 10:27:59 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:27:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:27:59 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:27:59 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 10:27:59 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 10:27:59 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 10:27:59 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 10:27:59 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 10:27:59 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 10:28:01 INFO - Downloading blessings-1.6.tar.gz 10:28:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:28:01 INFO - Installing collected packages: blessings 10:28:01 INFO - Running setup.py install for blessings 10:28:01 INFO - Successfully installed blessings 10:28:01 INFO - Cleaning up... 10:28:01 INFO - Return code: 0 10:28:01 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:28:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:28:01 INFO - Reading from file tmpfile_stdout 10:28:01 INFO - Current package versions: 10:28:01 INFO - argparse == 1.2.1 10:28:01 INFO - blessings == 1.6 10:28:01 INFO - blobuploader == 1.2.4 10:28:01 INFO - docopt == 0.6.1 10:28:01 INFO - functools32 == 3.2.3-2 10:28:01 INFO - jsonschema == 2.5.1 10:28:01 INFO - manifestparser == 1.1 10:28:01 INFO - mozInstall == 1.12 10:28:01 INFO - mozcrash == 0.17 10:28:01 INFO - mozdebug == 0.1 10:28:01 INFO - mozdevice == 0.48 10:28:01 INFO - mozfile == 1.2 10:28:01 INFO - mozhttpd == 0.7 10:28:01 INFO - mozinfo == 0.9 10:28:01 INFO - mozleak == 0.1 10:28:01 INFO - mozlog == 3.4 10:28:01 INFO - moznetwork == 0.27 10:28:01 INFO - mozprocess == 0.23 10:28:01 INFO - mozprofile == 0.28 10:28:01 INFO - mozrunner == 6.12 10:28:01 INFO - mozscreenshot == 0.1 10:28:01 INFO - mozsystemmonitor == 0.3 10:28:01 INFO - moztest == 0.7 10:28:01 INFO - mozversion == 1.4 10:28:01 INFO - psutil == 3.1.1 10:28:01 INFO - requests == 1.2.3 10:28:01 INFO - wsgiref == 0.1.2 10:28:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:28:01 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')]} 10:28:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:28:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:28:01 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')]} 10:28:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:28:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:28:01 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:28:01 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 10:28:01 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 10:28:01 INFO - Using env: {'DISPLAY': ':0', 10:28:01 INFO - 'HOME': '/home/cltbld', 10:28:01 INFO - 'LANG': 'en_US.UTF-8', 10:28:01 INFO - 'LANGUAGE': 'en_US:en', 10:28:01 INFO - 'LOGNAME': 'cltbld', 10:28:01 INFO - 'MAIL': '/var/mail/cltbld', 10:28:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:28:01 INFO - 'MOZ_NO_REMOTE': '1', 10:28:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:28:01 INFO - 'NO_EM_RESTART': '1', 10:28:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:28:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:28:01 INFO - 'PWD': '/builds/slave/test', 10:28:01 INFO - 'SHELL': '/bin/bash', 10:28:01 INFO - 'SHLVL': '1', 10:28:01 INFO - 'TERM': 'linux', 10:28:01 INFO - 'TMOUT': '86400', 10:28:01 INFO - 'USER': 'cltbld', 10:28:01 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:28:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:28:01 INFO - '_': '/tools/buildbot/bin/python'} 10:28:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 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)) 10:28:01 INFO - Cleaning up... 10:28:01 INFO - Return code: 0 10:28:01 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:28:01 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')]} 10:28:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:28:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:28:01 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')]} 10:28:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:28:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:28:01 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 0x7fc254bccf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd348a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe01790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, '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': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', '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 10:28:01 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 10:28:01 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 10:28:01 INFO - Using env: {'DISPLAY': ':0', 10:28:01 INFO - 'HOME': '/home/cltbld', 10:28:01 INFO - 'LANG': 'en_US.UTF-8', 10:28:01 INFO - 'LANGUAGE': 'en_US:en', 10:28:01 INFO - 'LOGNAME': 'cltbld', 10:28:01 INFO - 'MAIL': '/var/mail/cltbld', 10:28:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:28:01 INFO - 'MOZ_NO_REMOTE': '1', 10:28:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:28:01 INFO - 'NO_EM_RESTART': '1', 10:28:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:28:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:28:01 INFO - 'PWD': '/builds/slave/test', 10:28:01 INFO - 'SHELL': '/bin/bash', 10:28:01 INFO - 'SHLVL': '1', 10:28:01 INFO - 'TERM': 'linux', 10:28:01 INFO - 'TMOUT': '86400', 10:28:01 INFO - 'USER': 'cltbld', 10:28:01 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:28:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:28:01 INFO - '_': '/tools/buildbot/bin/python'} 10:28:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:28:02 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:28:02 INFO - Cleaning up... 10:28:02 INFO - Return code: 0 10:28:02 INFO - Running post-action listener: _resource_record_post_action 10:28:02 INFO - Running post-action listener: _start_resource_monitoring 10:28:02 INFO - Starting resource monitoring. 10:28:02 INFO - [mozharness: 2016-10-31 17:28:02.165444Z] Finished create-virtualenv step (success) 10:28:02 INFO - [mozharness: 2016-10-31 17:28:02.165966Z] Running install step. 10:28:02 INFO - Running pre-action listener: _resource_record_pre_action 10:28:02 INFO - Running main action method: install 10:28:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:28:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:28:02 INFO - Reading from file tmpfile_stdout 10:28:02 INFO - Detecting whether we're running mozinstall >=1.0... 10:28:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:28:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:28:02 INFO - Reading from file tmpfile_stdout 10:28:02 INFO - Output received: 10:28:02 INFO - Usage: mozinstall [options] installer 10:28:02 INFO - Options: 10:28:02 INFO - -h, --help show this help message and exit 10:28:02 INFO - -d DEST, --destination=DEST 10:28:02 INFO - Directory to install application into. [default: 10:28:02 INFO - "/builds/slave/test"] 10:28:02 INFO - --app=APP Application being installed. [default: firefox] 10:28:02 INFO - mkdir: /builds/slave/test/build/application 10:28:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:28:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:28:19 INFO - Reading from file tmpfile_stdout 10:28:19 INFO - Output received: 10:28:19 INFO - /builds/slave/test/build/application/firefox/firefox 10:28:19 INFO - Running post-action listener: _resource_record_post_action 10:28:19 INFO - [mozharness: 2016-10-31 17:28:19.426392Z] Finished install step (success) 10:28:19 INFO - [mozharness: 2016-10-31 17:28:19.426637Z] Running run-tests step. 10:28:19 INFO - Running pre-action listener: _resource_record_pre_action 10:28:19 INFO - Running main action method: run_tests 10:28:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:28:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:28:19 INFO - Python 2.7.3 10:28:19 INFO - Return code: 0 10:28:19 INFO - grabbing minidump binary from tooltool 10:28:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:28:19 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 0xdfe930>, '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 0xdff830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdffcc0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:28:19 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 10:28:19 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 10:28:19 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 10:28:19 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:28:19 INFO - Return code: 0 10:28:19 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:28:19 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:28:19 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:28:19 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:28:19 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:28:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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 10:28:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-027 --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 10:28:19 INFO - Using env: {'DISPLAY': ':0', 10:28:19 INFO - 'HOME': '/home/cltbld', 10:28:19 INFO - 'LANG': 'en_US.UTF-8', 10:28:19 INFO - 'LANGUAGE': 'en_US:en', 10:28:19 INFO - 'LOGNAME': 'cltbld', 10:28:19 INFO - 'MAIL': '/var/mail/cltbld', 10:28:19 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:28:19 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:28:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:28:19 INFO - 'MOZ_NO_REMOTE': '1', 10:28:19 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:28:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:28:19 INFO - 'NO_EM_RESTART': '1', 10:28:19 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:28:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:28:19 INFO - 'PWD': '/builds/slave/test', 10:28:19 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:28:19 INFO - 'SHELL': '/bin/bash', 10:28:19 INFO - 'SHLVL': '1', 10:28:19 INFO - 'TERM': 'linux', 10:28:19 INFO - 'TMOUT': '86400', 10:28:19 INFO - 'USER': 'cltbld', 10:28:19 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793', 10:28:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:28:19 INFO - '_': '/tools/buildbot/bin/python'} 10:28:19 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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 10:28:19 INFO - mozversion application_buildid: 20161031073220 10:28:19 INFO - mozversion application_changeset: c28bcbd086c2dc63e18e0b0c8a2ab7dbe0dce373 10:28:19 INFO - mozversion application_display_name: Nightly 10:28:19 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:28:19 INFO - mozversion application_name: Firefox 10:28:19 INFO - mozversion application_remotingname: firefox 10:28:19 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 10:28:19 INFO - mozversion application_vendor: Mozilla 10:28:19 INFO - mozversion application_version: 52.0a1 10:28:19 INFO - mozversion platform_buildid: 20161031073220 10:28:19 INFO - mozversion platform_changeset: c28bcbd086c2dc63e18e0b0c8a2ab7dbe0dce373 10:28:19 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 10:28:19 INFO - mozversion platform_version: 52.0a1 10:28:19 INFO - using testdate: 1477934899 10:28:19 INFO - actual date: 1477934899 10:28:19 INFO - starting webserver on 'localhost:50394' 10:28:19 INFO - SUITE-START | Running 2 tests 10:28:19 INFO - TEST-START | dromaeo_css 10:28:19 INFO - operating with platform_type : linux_ 10:28:19 INFO - Initialising browser for dromaeo_css test... 10:28:19 INFO - TEST-INFO | started process 22988 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpox9YuV/profile http://localhost:50394/getInfo.html) 10:28:23 INFO - PROCESS | 22988 | __metrics Screen width/height:1600/1200 10:28:23 INFO - PROCESS | 22988 | colorDepth:24 10:28:23 INFO - PROCESS | 22988 | Browser inner width/height: 1024/697 10:28:23 INFO - PROCESS | 22988 | __metrics 10:28:24 INFO - PROCESS | 22988 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 10:28:24 INFO - PROCESS | 22988 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:28:24 INFO - PROCESS | 22988 | console.error: PushService: 10:28:24 INFO - PROCESS | 22988 | stateChangeProcessEnqueue: Error transitioning state 10:28:24 INFO - PROCESS | 22988 | UnknownError 10:28:25 INFO - TEST-INFO | 22988: exit 0 10:28:25 INFO - Browser initialized. 10:28:25 INFO - Running cycle 1/1 for dromaeo_css test... 10:28:25 INFO - TEST-INFO | started process 23069 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpox9YuV/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:28:37 INFO - PROCESS | 23069 | RSS: Main: 174338048 10:28:37 INFO - PROCESS | 23069 | 10:29:29 INFO - PROCESS | 23069 | 1477934969032 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 10:31:39 INFO - PROCESS | 23069 | Cycle 1(1): loaded http://localhost:50394/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50394/tests/dromaeo/cssquery-ext.html) 10:31:40 INFO - PROCESS | 23069 | RSS: Main: 319016960 10:31:40 INFO - PROCESS | 23069 | 10:34:43 INFO - PROCESS | 23069 | Cycle 1(1): loaded http://localhost:50394/tests/dromaeo/cssquery-ext.html (next: http://localhost:50394/tests/dromaeo/cssquery-jquery.html) 10:34:43 INFO - PROCESS | 23069 | RSS: Main: 262688768 10:34:43 INFO - PROCESS | 23069 | 10:37:45 INFO - PROCESS | 23069 | Cycle 1(1): loaded http://localhost:50394/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50394/tests/dromaeo/cssquery-mootools.html) 10:37:46 INFO - PROCESS | 23069 | RSS: Main: 218423296 10:37:46 INFO - PROCESS | 23069 | 10:40:48 INFO - PROCESS | 23069 | Cycle 1(1): loaded http://localhost:50394/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50394/tests/dromaeo/cssquery-prototype.html) 10:40:49 INFO - PROCESS | 23069 | RSS: Main: 216535040 10:40:49 INFO - PROCESS | 23069 | 10:43:51 INFO - PROCESS | 23069 | Cycle 1(1): loaded http://localhost:50394/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50394/tests/dromaeo/cssquery-yui.html) 10:43:52 INFO - PROCESS | 23069 | RSS: Main: 215134208 10:43:52 INFO - PROCESS | 23069 | 10:46:54 INFO - PROCESS | 23069 | Cycle 1(1): loaded http://localhost:50394/tests/dromaeo/cssquery-yui.html (next: http://localhost:50394/tests/dromaeo/cssquery-dojo.html) 10:46:55 INFO - PROCESS | 23069 | RSS: Main: 310824960 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | __start_tp_report 10:46:55 INFO - PROCESS | 23069 | _x_x_mozilla_page_load 10:46:55 INFO - PROCESS | 23069 | _x_x_mozilla_page_load_details 10:46:55 INFO - PROCESS | 23069 | |i|pagename|runs| 10:46:55 INFO - PROCESS | 23069 | |0;dojo.html;2922.1379692990567;2930.930210473175;2973.1229287360225;2981.3739114785894;2989.6262967129096;5114.207297868827;5179.860430705248;5287;5352.06338890694;5410.16142497913;5214.348206474191;5254.316938797961;5327.121025030865;5334.5999050071205;5387.353517577886;4761.119192949298;4776.402949631296;4815.951840481603;4827.951720482785;4870.951290487085;4896.1186986342445;4914.705117692932;4946.653734238586;4947.03532811102;5005.074061298671;4648.651351148644;4891.9755401222765;4906.411230652345;4927.6797008194535;5013.398392192924;4696.765161741933;4752.691075080109;4772.117158325721;4819.349387832668;4830.541098595628;4781.713097214179;4783.617310615143;4789.353437285957;4837.201861692816;4858.416989961192;5273;5315.202719592092;5326.440723723992;5330.227117068003;5332.493413125747;5471.753771080311;5489.1217405214975;5587;5615.494605485485;5627.8593035174035;5658.0381335173115;5682.602217844753;5686.914696279559;5737.311522617271;5756.942430575725;5295.443978382253;5303.257543943851;5306.044911915892;5306.09796334624;5306.416294207634;5530.5852061095575;5570.387257401682;5750.769969201268;5774;5812.82561523155;5556.055470570012;5595.720213989365;5604.411536788579;5668.348139963874;5672.177534257509;5643.068893632505;5645.915311270334;5679.460451257124;5696.401877802771;5698.401667824902;5453.291072160673;5484.177373394023;5666.376698563155;5684.204211410406;5687.914681279784;5517.144842549331;5552.111662134039;5562.888742225133;5572.693501857356;5647.491725744702;4302.139572085595;4309.84915527955;4311.611954924009;4345.435093437833;4401.823927042947;3856.4022576500124;3870.632289932452;3873.6320049595242;3909.081365879016;3919.6668283195677;5171.896562068738;5224.373075230997;5326.573874090063;5351.224072509464;5374.167004114369;5689.288838895138;5710.71446427677;5711.7144142792695;5714.085746280575;5768.942310576925;5339.359276886798;5384.6769193848495;5386.192071189353;5387.218853266255;5387.81142660005;4738.976305118453;4788.545088216614;4834.371531700856;4872.610191184696;4943.752812359367;5875.265591801025;5878.3239927408895;5885.5585831062845;5918.7928422505;5948.048312270016;5636.520895723909;5647.29408823897;5650.378458369658;5652.915206271827;5653.745581448762;5682.9147562785765;5729.1119876419225;5805.448482394166;5834.241548598655;5876.853078673067;5535.39110697831;5598.188262701967;5600.803971860965;5637.351704554028;5653.689047102449;5626.099824028136;5637.774489020558;5682.829515114553;5688.288963879515;5690.971545142248;5407.297051383295;5481.561475081904;5581.469760372758;5581.49766521015;5592.69240191777;5504;5536.031194540858;5550;5565.3599836019375;5626.24045753818;5499.780008799603;5539.8892022160135;5544.251526044094;5546.500814926676;5558.360788509373;5419.539339156058;5605.5795815313195;5607.719614019201;5611.943880561143;5676.318841739017;5342.278792363137;5424.484673955968;5454.290942177491;5479.753411096431;5544.306961629796 10:46:55 INFO - PROCESS | 23069 | |1;ext.html;555.8616587106935;588.9146073819295;608.3460280198788;622.7166639179173;662.6355504472539;30704.692953070462;41423.993520939446;42678.14643707128;42682.359764603556;42684.14631707364;44262.336064959054;44688;45006.54993450065;45052.774736126354;45060.549394506044;7915.445918785687;8799.648014079445;8949.373543851932;8949.686760963368;8957.776055598597;7927.28654421102;10387.065164135227;10658.253922225409;10659.680209593686;11014.559417623326;10865.45672716361;10898.945505272462;10915.617953371633;10925.726856828564;10931.836022459669;10556.78886422275;10568.947155264252;10619.36283822973;10629.9468502657;10636.149108071375;10546.789064218749;10601.151907847354;10624.30941988776;10627;10630.30902991303;41718.37422438666;42043;42054.78972605148;42070.36894446586;42093.15813683709;3446.9310613787834;3555.964440355615;3703.8703645372284;3951.6443520083044;4134.607212314825;30645.540316895265;31473;31510.212244693837;31638.367232655448;32032.519512207335;4250.171216612762;4409.559044095597;4525.524819893897;4559.270516717309;4607.815687372501;311813;314949;315082;316269.41865290754;317358;33061.66938330634;33238;33788;55024.449755502734;55456.44543554513;35354;35380.64619353825;35497.46753798695;35502.28995420077;35513.28973420517;15057.924710376377;15176.468823591122;15183.240837958057;15270.770938435933;15282.923585382003;11388.20282580228;11684.18210725241;12461.252324860538;12891.097623166288;12907.483700652057;8026.799330016796;8130.75607731769;8175.959120204361;8267.29727973117;8294.29498492635;3151.275206702471;3183.4906414973957;3210.9839450803065;3260.3805276997296;3278.5901762279714;997.2670087485692;1007.6171054999054;1018.8879223285433;1041.1358572384902;1103.8013157631542;30374.69625303763;30745.538816917764;30978.22554436112;31070.22324441907;31174.376512469622;1094.1520321750706;1139.8575178102737;1160.8955194032408;1175.9470823812949;1211.684961909892;15997;16394;16643.750343744854;16653.50039498817;16852.32590696383;516437;521713;521713;523849;524028;56411;56912.43087569071;56922;56946.145807812914;56970.43029569651;1171.2035815645272;1245.8567264764488;1264.6522206393315;1299.8635143309816;1354.038632570866;29507.262318442212;30896.382072358876;31821.20446988844;32111.518327224643;32311;47144.7642761784;47800.52199477961;47933.76033119812;47947;47963.76018119887;357258;358902;359397;359462;359623.2018839889;26340.20979370622;26761.197164085108;26850.06024789123;28195.295117622223;28438.85780571084;44536.77731611321;45013.32480012737;45280.77359613181;45323.77338113288;45611.54388456073;38521.422178666784;38711.6128838708;39042.80478597702;39164.6083539161;40192;38708.225835483696;38840.41739373855;39318.28180618344;39741;40323.59676403199;38797.6120238794;39206.215875682894;39313.13737252504;40158.397624036246;40277;33160.834195828866;34331.31337373288;34714.9585512435;35339.823300883334;35742.64257357497;26676.59985100264;26834.463310733285;27240.72759272382;27302;27496.725032749415 10:46:55 INFO - PROCESS | 23069 | |2;jquery.html;372.9608391118934;394.26469634132354;397.6103418649723;406.6990427083958;416.15642702826466;13456;15572.688546229083;17228.82771172288;19518.902405487952;19805.900970495128;19316.420507384766;19512.31706890259;19692.310769123083;19898.10458529366;19921.501962450948;4513.954860451403;5483.725813709329;5672.574556908227;5702.7433765480655;5710.257666503348;4097.7541347519245;4327.826886924535;5677.148427735852;5732.140178973166;5769.798057068004;6041.335453100155;6413.198350206224;6425.389587989133;6517.543771935966;6531.51013673974;6289.496840252768;6402.327755585667;6439.871202575969;6440.774572889974;6539.313372095933;5672.858178545569;5675.858103547403;5680.176374425727;5681.573881958829;5700.116481945305;20989.68515472269;21927.780722192732;22161.44596385087;23150.42123946898;23161.53676926452;2407.2898494944034;2507.360623041113;2566.5508536006123;2693.2189664997322;2906.3606006678497;10363.585456581728;10661.786764264749;13092.149010314395;13738.65653358674;14218.786718199235;1891.1206289075508;1943.7667479902361;1944.0959953621634;1955.599102184049;1987.8111579399933;68437.78746550446;75491.24508754897;77627.6118619409;81291.18708812895;81359.5932020336;10635.361878287173;10725.570977160982;10801.351918884891;10922.781544369227;11042.558297668003;15416.304206537272;15452.291450052131;15452.5364239073;15529.45646902353;15550;7585.848283034419;7759.7672069838;7850.371970242367;7890.526568405914;8052.516848989079;7409.110906691124;7451.3293803557945;7499.925000750031;7516.849663006709;7624.618769061524;4684.718916864999;4696.506866778939;4708.623310135181;4724.929126063112;4829.830955916526;1823.2433540080717;1863.5154859736567;1918.1080797428983;1958.7159861819957;2003.6393449179288;827.7061643116607;962.1244667352676;992.0426788149326;1003.5684655598163;1057.3021805608262;18849.434516964513;19313;19416.320428785206;19490.512737181685;19888.50278743043;953.7663272498282;980.3725615606018;1004.1013293102632;1007.7682133109425;1032.6850310655173;10235.641752538775;10874.782504349869;10969;11033.172512061628;11071.114310855111;457204;464650;464736;465562;470183;85673.57163214144;86648;88452;88766.78632495663;90473;1002.9147522460672;1018.760591261053;1032.4218437674776;1050.56926660069;1054.2356791326226;16115.274812633224;16593.41923032688;17022;17296.567585810455;17543.912280438515;40464.79767601143;41408;41527.792361038;41602.37596436116;41750.16499670051;54248.45751542434;55612.72193639006;56383.71808140933;56416.43583564112;56565;8281.668733250603;8388.286995605442;8530.274926631058;8551.871721924052;8716.477011379338;9547.09058188379;12459.688507787378;13034.739305213652;13153.145045572008;13233.735325293634;11298.322100673986;11697.590584329508;11770.82343764827;11826.526938922347;12109;11287.548498059985;11366.261193022427;11510.884891150981;11685.298882067103;11869.287842729464;11217.66347009591;11377.772444551229;11564.132690048113;11654.533818647498;12207.69480762988;7999.4400391972;8148.633311501115;8605;8671.132886711279;8772.078931712078;10136;10886.891131088587;10921.180911431833;11116.833247501132;11695.649130526097 10:46:55 INFO - PROCESS | 23069 | |3;mootools.html;1487.4868170481186;1516.628426035621;1670.9749353759696;1773.9379121730742;1813.3109418420997;7577.507462014965;7841.4118941079505;8133.146019667938;8673.91326086739;8673.91326086739;8128.146544612804;8434.114417986115;8462.280706139985;8662.610182541785;8731.912680873189;2220.5003874128315;2256.650219216024;2256.7968882800546;2261.9886900565475;2282.532080923415;1998.1807458941837;2225.7996780289773;2261.3442101790542;2282.7717228277206;2286.6455699366543;2009.447401964457;2161.945951351221;2244.3267019894047;2251.6960210371553;2263.9773602264013;2214.1807531213394;2220.844540882139;2224.710787597602;2233.336164557407;2247.910083596654;2201.7027701260445;2218.190360518415;2224.7219097612797;2232.0960011195493;2234.2626933112197;8571.14288571144;8613.095624959415;8685.913140868573;8687.305015598737;8702.042775294713;4851.636127290467;4948.925766113512;5068.341115654941;5070.645054846163;5072.416672082684;3264.6245681746427;3324.517944898;3452.9654703452893;3467.9826600866836;3471.340445315407;1087.6302057300477;1095.649392194498;1145.6906635208447;1154.4747140051256;1157.2477889371892;11967.700807479796;11974.940125299405;11977.401129943468;11997.640070797803;12000.819987700192;4216.283231850532;4495.842645507457;4508.729476231437;4540.205464043779;4540.364348991144;10042.799144017225;10059.497025148714;10063.345882517613;10067.1442927352;10072.244581656405;5105.642605017613;5106.387233532;5112.488751124858;5117.283580298761;5128.384593848762;4612.838550650778;4639.095376401637;4653.604443622262;4697.81208751653;4713.78787954536;3723.255348930171;3768.717346199046;3844.2888065707934;3863.439801228806;3891.3190191716335;1087.3693257910393;1199.3883119609063;1201.1531870031606;1214.4170798017;1223.473906220334;803.6504120707394;923;930.7580029192324;937.1706040154512;944.5230158769915;5546.722663866791;5671.432856714296;5682.829515114553;5698.344690360579;5702;925.4031149908271;971.8930917599058;1010.0757806606872;1010.242318261304;1018.6994836523244;3735.364987952055;3767.868124615625;3818.1790914953417;3819.52255968004;3851.287511810324;10489.580416783396;10644.680659580225;10758.139348852073;10767.515461804238;10815.026647601597;10612.20408469368;10646.467676616137;10672.359658420519;10697.251192416456;10717.196210284259;7410.481266311414;7717.459777815499;8082.555459449787;8188.467749596257;8231.588420578948;5749.8275051748515;5755.424457554211;5839.503642190291;5861.35525092248;5944.8811023780145;9537.14165725088;9598.280128990215;9649.855252171363;9737.464439455614;9922.900770992197;9841.60633574649;9861.359011664219;9957;9967.700968970943;10065.899341006496;7259.165196002527;7510.662020209213;7617.542947423172;7741.690332386642;7765.0681918170185;8141.552214628252;8263;8279.95860020696;8281.792955176168;8292.543910084762;6884.690188941409;6984.511084224056;7155.713771449292;7318.743843965436;7415.777526674208;7055.470839686941;7134.46491513149;7186.245444228281;7265.9273407265255;7301.452391070585;6434.710438030206;6436.678166091583;6489.805305840832;6502.154719886385;6513.772017979538;4689.953100468952;4692.272697731857;4714.057188562233;4723.6929599575915;4756.785944632431;4567.1550763108935;4599.988002639414;4629.444466664022;4763.857084287477;4798.160321943716 10:46:55 INFO - PROCESS | 23069 | |4;prototype.html;292.1702365282598;305.6301874731575;307.93071558899237;310.2878892940702;310.69862233633376;5219.478052194788;5253.268300483746;5293.629445938776;5351.2775775270375;5360.517553420192;5119;5189.195674670423;5203.609729270301;5212.061828870802;5246.475352464751;4090.9590904091024;4095.201435720036;4108.342665173573;4109.383592461125;4161.563035881234;3845.692344612424;4045.919081618366;4126.730298335903;4130.483689538808;4157.189348077126;4040.979795101035;4046.8988275293204;4050.23045621331;4051.5948405159397;4061.370487574416;4033.757974521538;4037.1320166164123;4043.9687879590515;4044.6157615026527;4072.5112986441522;3566.4293713006055;3573.356795776759;3573.4818451324672;3578.284343131358;3587.192881601645;5123.769430375642;5128.384593848725;5161.896762064775;5185.948140518584;5188.325517682715;4636.724900652314;4639.907201855944;4649.814297354153;4673.205555055615;4677.4854765975715;5484.780608775644;5494;5496.120620700669;5508.55931525477;5527.944720552783;3800.9429858552144;3869.7097717671286;3877.8836634901;3881.2237552489614;3896.5518965319066;5687.658740475544;5718.711740749086;5723.54211663066;5727.255456790632;5732;3965.6629186518894;3966.345552983783;3967.821448034845;3972.5431575369203;4003.919921601552;3939.527256729211;3988.481497405319;3996.3424322825576;4013.1973605279063;4042;4605.65457590682;4606.815727370935;4619.815207391666;4621.214393553104;4630.629549636021;5538.778448862081;5570.944290557123;5607.495325420732;5611.9719401403545;5664.51851592611;1312.4356526693614;1319.469415478041;1337.2177276293282;1339.2834833364298;1366.863313668625;910.9453432794054;923.215267023025;938.2915898496591;939.6006697153819;945.8723072385278;5286.5506431952945;5313.415524292324;5319.893602127936;5341.4925582069645;5358.356997160366;5565.554755619541;5580.944190558123;5593.860153496195;5648.717564121777;5662.518685911661;5109.310243117132;5331.653442526223;5334.546563542065;5347.51872331492;5383.16560933056;3005.6543497497632;3025.909222723322;3029.6822930458216;3032.757379409642;3040.315928915976;5898.8230353089475;5902.911456328158;5921.881562368729;5928.377520360386;5935.940640593625;5563.805266815642;5714.000149921241;5761.279840019997;5772;5779.248697669276;5853.64878107315;5873.353931067579;5883.58793889472;5926.970365148147;5936;5456.236126942152;5652.98637967048;5662.8018019370775;5693.975084484832;5704.572157088152;5634.915476267777;5640.210370548045;5650.943490565041;5663.9716801415725;5669.270872383962;5912.320083190316;5929.695466997254;5943.286805583358;5955.9577074011;5975.880482390241;3864.9227015460096;3874.49631547897;3895.24042811649;3908.159745654698;3916.118873253495;5444.8366549003595;5665.376808551138;5720.885582288414;5722.914156287742;5732.856678583069;5511.429242665821;5512.503874651301;5564.8330550083565;5566.053770858883;5578.246936663661;5535.446455354593;5537.446255374592;5570.944290557042;5573.8606534835335;5582.609217354746;5368.308982670446;5501.752421140978;5542.473465020817;5554.50009499147;5581.944180558305;5568.638038527482;5587.944120558743;5596.18855265976;5610.943890561042;5611.691356975405;5482.671039737628;5483;5502.174673798962;5507.284053073075;5529.889402212014 10:46:55 INFO - PROCESS | 23069 | |5;yui.html;725.9201487836339;750.9224263182331;762.5920132728987;773.9342155916745;819.7458787775786;14576.489822856201;14925.179115148663;15224.314905829237;15494.767578486317;15660.84339156608;13295;13498.190108593466;13519.053666243366;13541.119827211225;13649.72700545991;809.4778867630375;820.2412768189431;830.0869044051556;830.7175560309523;831.4678605692332;669.5681285570804;680.4556354916048;805.1304591041691;818.2186012358184;835.2357592802579;868.3313848336777;874.1608056265992;874.2699845628907;876.2464280718577;876.3164731509432;867.822096470222;870.8998465176522;871.4509858788954;871.5337294547419;871.6426265231288;515.1217174717099;525.1099386539817;615.6244690738646;625.5902383938527;635.0093853588417;14539.927300363537;14731.926340368336;14741.336639851232;14755.336009879582;14764.852351476455;12839.935800320938;13187.736245275137;13590.59228223155;13695.520656777064;13707.588772336845;11781.293122412682;11933.94033029838;12160.878391216063;12231.266124032587;12262.141650084497;4325.545817689129;4366.432363792686;4387.407699960497;4408.272635015219;4413.713108647928;59587.40412595905;59699.53755780528;60081.69959150176;62725;63395.97738214862;9793;10357.63748268807;10519.894801052045;10575.312604680672;10679.412632305297;19256.614867702567;19501.219951202078;19523;19732.210711571377;19995.900020500096;7597.772066838003;7733.535987840747;7789.454738168274;7933.286004259644;8105.027396712432;4624.861254162381;4625.236835922035;4737.1236321279985;4783.6651434399255;4851.733154676526;3352.6814952579466;3448.74134439913;3461.1866211440292;3475.565554305712;3484;598.1685457214476;648.0570769530322;670.5741853922697;674.2448457727279;679.0255982664793;623.0467384901109;665.8734840380313;709.1277728394001;715.5492040014861;747.3535391885979;9373.953130234306;9426.151646351724;9587.616495340108;9657.46883921391;9761.121499065119;584.5294537896949;652.4160876015939;722.2272168779356;728.7012324946852;756.5120497279335;4464.419625448736;4603.194440972817;4757.952420475751;4816.301636262722;4822.758862056883;51614.709352316946;52741.208881866805;52868.471315286355;53458;53544.19683704748;48202;61105.38894610997;64098.0385294221;78328;79539;41251.793741031106;52297.215541766906;55780.721096394256;61790.382096178466;65153.67423162854;9372.95313523428;9889.307748457539;9981.850272246067;10082.546285417027;10133.189344852246;42041;43260.30375253009;45151;45479.77260113811;45816;56915;61062.38937610567;61389.40548323149;62504.374956251675;62613.686931566874;12035.638930832089;12235.449404776984;12279.815802763145;12298.877011229773;12791.168574042658;12968.740625187633;13827.930860345634;13829.585112446643;14066.859331406555;14073.225972571197;13101;13198.80201796993;13359.198448092757;13519;14146.43414263459;12704.237745735285;13014.349282535646;13124.671883202996;13654.86345136536;13659.521916732867;12818.359082046047;13219.933900330438;13508.932455337661;13805.930970345084;13948.372323245276;10218.437985910847;10474.214433917334;10627.095257308756;10630.681079567625;10682.946585267024;10700.30448020876;10840.67477975662;10848.945755271174;11057.5024123913;11186 10:46:55 INFO - PROCESS | 23069 | __end_tp_report 10:46:55 INFO - PROCESS | 23069 | __start_cc_report 10:46:55 INFO - PROCESS | 23069 | _x_x_mozilla_cycle_collect,1268 10:46:55 INFO - PROCESS | 23069 | __end_cc_report 10:46:55 INFO - PROCESS | 23069 | __startTimestamp1477936015233__endTimestamp 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | ------- Summary: start ------- 10:46:55 INFO - PROCESS | 23069 | Number of tests: 6 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | [#0] dojo.html Cycles:165 Average:5256.84 Median:5479.75 stddev:603.04 (11.0%) stddev-sans-first:576.41 10:46:55 INFO - PROCESS | 23069 | Values: 2922.1 2930.9 2973.1 2981.4 2989.6 5114.2 5179.9 5287.0 5352.1 5410.2 5214.3 5254.3 5327.1 5334.6 5387.4 4761.1 4776.4 4816.0 4828.0 4871.0 4896.1 4914.7 4946.7 4947.0 5005.1 4648.7 4892.0 4906.4 4927.7 5013.4 4696.8 4752.7 4772.1 4819.3 4830.5 4781.7 4783.6 4789.4 4837.2 4858.4 5273.0 5315.2 5326.4 5330.2 5332.5 5471.8 5489.1 5587.0 5615.5 5627.9 5658.0 5682.6 5686.9 5737.3 5756.9 5295.4 5303.3 5306.0 5306.1 5306.4 5530.6 5570.4 5750.8 5774.0 5812.8 5556.1 5595.7 5604.4 5668.3 5672.2 5643.1 5645.9 5679.5 5696.4 5698.4 5453.3 5484.2 5666.4 5684.2 5687.9 5517.1 5552.1 5562.9 5572.7 5647.5 4302.1 4309.8 4311.6 4345.4 4401.8 3856.4 3870.6 3873.6 3909.1 3919.7 5171.9 5224.4 5326.6 5351.2 5374.2 5689.3 5710.7 5711.7 5714.1 5768.9 5339.4 5384.7 5386.2 5387.2 5387.8 4739.0 4788.5 4834.4 4872.6 4943.8 5875.3 5878.3 5885.6 5918.8 5948.0 5636.5 5647.3 5650.4 5652.9 5653.7 5682.9 5729.1 5805.4 5834.2 5876.9 5535.4 5598.2 5600.8 5637.4 5653.7 5626.1 5637.8 5682.8 5688.3 5691.0 5407.3 5481.6 5581.5 5581.5 5592.7 5504.0 5536.0 5550.0 5565.4 5626.2 5499.8 5539.9 5544.3 5546.5 5558.4 5419.5 5605.6 5607.7 5611.9 5676.3 5342.3 5424.5 5454.3 5479.8 5544.3 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | [#1] ext.html Cycles:180 Average:54698.53 Median:35027.39 stddev:108322.84 (309.3%) stddev-sans-first:108550.43 10:46:55 INFO - PROCESS | 23069 | Values: 555.9 588.9 608.3 622.7 662.6 30704.7 41424.0 42678.1 42682.4 42684.1 44262.3 44688.0 45006.5 45052.8 45060.5 7915.4 8799.6 8949.4 8949.7 8957.8 7927.3 10387.1 10658.3 10659.7 11014.6 10865.5 10898.9 10915.6 10925.7 10931.8 10556.8 10568.9 10619.4 10629.9 10636.1 10546.8 10601.2 10624.3 10627.0 10630.3 41718.4 42043.0 42054.8 42070.4 42093.2 3446.9 3556.0 3703.9 3951.6 4134.6 30645.5 31473.0 31510.2 31638.4 32032.5 4250.2 4409.6 4525.5 4559.3 4607.8 311813.0 314949.0 315082.0 316269.4 317358.0 33061.7 33238.0 33788.0 55024.4 55456.4 35354.0 35380.6 35497.5 35502.3 35513.3 15057.9 15176.5 15183.2 15270.8 15282.9 11388.2 11684.2 12461.3 12891.1 12907.5 8026.8 8130.8 8176.0 8267.3 8294.3 3151.3 3183.5 3211.0 3260.4 3278.6 997.3 1007.6 1018.9 1041.1 1103.8 30374.7 30745.5 30978.2 31070.2 31174.4 1094.2 1139.9 1160.9 1175.9 1211.7 15997.0 16394.0 16643.8 16653.5 16852.3 516437.0 521713.0 521713.0 523849.0 524028.0 56411.0 56912.4 56922.0 56946.1 56970.4 1171.2 1245.9 1264.7 1299.9 1354.0 29507.3 30896.4 31821.2 32111.5 32311.0 47144.8 47800.5 47933.8 47947.0 47963.8 357258.0 358902.0 359397.0 359462.0 359623.2 26340.2 26761.2 26850.1 28195.3 28438.9 44536.8 45013.3 45280.8 45323.8 45611.5 38521.4 38711.6 39042.8 39164.6 40192.0 38708.2 38840.4 39318.3 39741.0 40323.6 38797.6 39206.2 39313.1 40158.4 40277.0 33160.8 34331.3 34715.0 35339.8 35742.6 26676.6 26834.5 27240.7 27302.0 27496.7 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | [#2] jquery.html Cycles:180 Average:27929.01 Median:2536.96 stddev:76552.23 (3017.5%) stddev-sans-first:76739.02 10:46:55 INFO - PROCESS | 23069 | Values: 373.0 394.3 397.6 406.7 416.2 13456.0 15572.7 17228.8 19518.9 19805.9 19316.4 19512.3 19692.3 19898.1 19921.5 4514.0 5483.7 5672.6 5702.7 5710.3 4097.8 4327.8 5677.1 5732.1 5769.8 6041.3 6413.2 6425.4 6517.5 6531.5 6289.5 6402.3 6439.9 6440.8 6539.3 5672.9 5675.9 5680.2 5681.6 5700.1 20989.7 21927.8 22161.4 23150.4 23161.5 2407.3 2507.4 2566.6 2693.2 2906.4 10363.6 10661.8 13092.1 13738.7 14218.8 1891.1 1943.8 1944.1 1955.6 1987.8 68437.8 75491.2 77627.6 81291.2 81359.6 10635.4 10725.6 10801.4 10922.8 11042.6 15416.3 15452.3 15452.5 15529.5 15550.0 7585.8 7759.8 7850.4 7890.5 8052.5 7409.1 7451.3 7499.9 7516.8 7624.6 4684.7 4696.5 4708.6 4724.9 4829.8 1823.2 1863.5 1918.1 1958.7 2003.6 827.7 962.1 992.0 1003.6 1057.3 18849.4 19313.0 19416.3 19490.5 19888.5 953.8 980.4 1004.1 1007.8 1032.7 10235.6 10874.8 10969.0 11033.2 11071.1 457204.0 464650.0 464736.0 465562.0 470183.0 85673.6 86648.0 88452.0 88766.8 90473.0 1002.9 1018.8 1032.4 1050.6 1054.2 16115.3 16593.4 17022.0 17296.6 17543.9 40464.8 41408.0 41527.8 41602.4 41750.2 54248.5 55612.7 56383.7 56416.4 56565.0 8281.7 8388.3 8530.3 8551.9 8716.5 9547.1 12459.7 13034.7 13153.1 13233.7 11298.3 11697.6 11770.8 11826.5 12109.0 11287.5 11366.3 11510.9 11685.3 11869.3 11217.7 11377.8 11564.1 11654.5 12207.7 7999.4 8148.6 8605.0 8671.1 8772.1 10136.0 10886.9 10921.2 11116.8 11695.6 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | [#3] mootools.html Cycles:180 Average:5583.88 Median:4691.11 stddev:3197.27 (68.2%) stddev-sans-first:3191.43 10:46:55 INFO - PROCESS | 23069 | Values: 1487.5 1516.6 1671.0 1773.9 1813.3 7577.5 7841.4 8133.1 8673.9 8673.9 8128.1 8434.1 8462.3 8662.6 8731.9 2220.5 2256.7 2256.8 2262.0 2282.5 1998.2 2225.8 2261.3 2282.8 2286.6 2009.4 2161.9 2244.3 2251.7 2264.0 2214.2 2220.8 2224.7 2233.3 2247.9 2201.7 2218.2 2224.7 2232.1 2234.3 8571.1 8613.1 8685.9 8687.3 8702.0 4851.6 4948.9 5068.3 5070.6 5072.4 3264.6 3324.5 3453.0 3468.0 3471.3 1087.6 1095.6 1145.7 1154.5 1157.2 11967.7 11974.9 11977.4 11997.6 12000.8 4216.3 4495.8 4508.7 4540.2 4540.4 10042.8 10059.5 10063.3 10067.1 10072.2 5105.6 5106.4 5112.5 5117.3 5128.4 4612.8 4639.1 4653.6 4697.8 4713.8 3723.3 3768.7 3844.3 3863.4 3891.3 1087.4 1199.4 1201.2 1214.4 1223.5 803.7 923.0 930.8 937.2 944.5 5546.7 5671.4 5682.8 5698.3 5702.0 925.4 971.9 1010.1 1010.2 1018.7 3735.4 3767.9 3818.2 3819.5 3851.3 10489.6 10644.7 10758.1 10767.5 10815.0 10612.2 10646.5 10672.4 10697.3 10717.2 7410.5 7717.5 8082.6 8188.5 8231.6 5749.8 5755.4 5839.5 5861.4 5944.9 9537.1 9598.3 9649.9 9737.5 9922.9 9841.6 9861.4 9957.0 9967.7 10065.9 7259.2 7510.7 7617.5 7741.7 7765.1 8141.6 8263.0 8280.0 8281.8 8292.5 6884.7 6984.5 7155.7 7318.7 7415.8 7055.5 7134.5 7186.2 7265.9 7301.5 6434.7 6436.7 6489.8 6502.2 6513.8 4690.0 4692.3 4714.1 4723.7 4756.8 4567.2 4600.0 4629.4 4763.9 4798.2 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | [#4] prototype.html Cycles:180 Average:4646.59 Median:5349.40 stddev:1393.02 (26.0%) stddev-sans-first:1358.05 10:46:55 INFO - PROCESS | 23069 | Values: 292.2 305.6 307.9 310.3 310.7 5219.5 5253.3 5293.6 5351.3 5360.5 5119.0 5189.2 5203.6 5212.1 5246.5 4091.0 4095.2 4108.3 4109.4 4161.6 3845.7 4045.9 4126.7 4130.5 4157.2 4041.0 4046.9 4050.2 4051.6 4061.4 4033.8 4037.1 4044.0 4044.6 4072.5 3566.4 3573.4 3573.5 3578.3 3587.2 5123.8 5128.4 5161.9 5185.9 5188.3 4636.7 4639.9 4649.8 4673.2 4677.5 5484.8 5494.0 5496.1 5508.6 5527.9 3800.9 3869.7 3877.9 3881.2 3896.6 5687.7 5718.7 5723.5 5727.3 5732.0 3965.7 3966.3 3967.8 3972.5 4003.9 3939.5 3988.5 3996.3 4013.2 4042.0 4605.7 4606.8 4619.8 4621.2 4630.6 5538.8 5570.9 5607.5 5612.0 5664.5 1312.4 1319.5 1337.2 1339.3 1366.9 910.9 923.2 938.3 939.6 945.9 5286.6 5313.4 5319.9 5341.5 5358.4 5565.6 5580.9 5593.9 5648.7 5662.5 5109.3 5331.7 5334.5 5347.5 5383.2 3005.7 3025.9 3029.7 3032.8 3040.3 5898.8 5902.9 5921.9 5928.4 5935.9 5563.8 5714.0 5761.3 5772.0 5779.2 5853.6 5873.4 5883.6 5927.0 5936.0 5456.2 5653.0 5662.8 5694.0 5704.6 5634.9 5640.2 5650.9 5664.0 5669.3 5912.3 5929.7 5943.3 5956.0 5975.9 3864.9 3874.5 3895.2 3908.2 3916.1 5444.8 5665.4 5720.9 5722.9 5732.9 5511.4 5512.5 5564.8 5566.1 5578.2 5535.4 5537.4 5570.9 5573.9 5582.6 5368.3 5501.8 5542.5 5554.5 5581.9 5568.6 5587.9 5596.2 5610.9 5611.7 5482.7 5483.0 5502.2 5507.3 5529.9 10:46:55 INFO - PROCESS | 23069 | 10:46:55 INFO - PROCESS | 23069 | [#5] yui.html Cycles:180 Average:16068.95 Median:4681.18 stddev:19383.25 (414.1%) stddev-sans-first:19403.38 10:46:55 INFO - PROCESS | 23069 | Values: 725.9 750.9 762.6 773.9 819.7 14576.5 14925.2 15224.3 15494.8 15660.8 13295.0 13498.2 13519.1 13541.1 13649.7 809.5 820.2 830.1 830.7 831.5 669.6 680.5 805.1 818.2 835.2 868.3 874.2 874.3 876.2 876.3 867.8 870.9 871.5 871.5 871.6 515.1 525.1 615.6 625.6 635.0 14539.9 14731.9 14741.3 14755.3 14764.9 12839.9 13187.7 13590.6 13695.5 13707.6 11781.3 11933.9 12160.9 12231.3 12262.1 4325.5 4366.4 4387.4 4408.3 4413.7 59587.4 59699.5 60081.7 62725.0 63396.0 9793.0 10357.6 10519.9 10575.3 10679.4 19256.6 19501.2 19523.0 19732.2 19995.9 7597.8 7733.5 7789.5 7933.3 8105.0 4624.9 4625.2 4737.1 4783.7 4851.7 3352.7 3448.7 3461.2 3475.6 3484.0 598.2 648.1 670.6 674.2 679.0 623.0 665.9 709.1 715.5 747.4 9374.0 9426.2 9587.6 9657.5 9761.1 584.5 652.4 722.2 728.7 756.5 4464.4 4603.2 4758.0 4816.3 4822.8 51614.7 52741.2 52868.5 53458.0 53544.2 48202.0 61105.4 64098.0 78328.0 79539.0 41251.8 52297.2 55780.7 61790.4 65153.7 9373.0 9889.3 9981.9 10082.5 10133.2 42041.0 43260.3 45151.0 45479.8 45816.0 56915.0 61062.4 61389.4 62504.4 62613.7 12035.6 12235.4 12279.8 12298.9 12791.2 12968.7 13827.9 13829.6 14066.9 14073.2 13101.0 13198.8 13359.2 13519.0 14146.4 12704.2 13014.3 13124.7 13654.9 13659.5 12818.4 13219.9 13508.9 13805.9 13948.4 10218.4 10474.2 10627.1 10630.7 10682.9 10700.3 10840.7 10848.9 11057.5 11186.0 10:46:55 INFO - PROCESS | 23069 | -------- Summary: end -------- 10:46:55 INFO - PROCESS | 23069 | 10:46:56 INFO - TEST-INFO | 23069: exit 0 10:46:56 INFO - TEST-OK | dromaeo_css | took 1116430ms 10:46:56 INFO - TEST-START | kraken 10:46:56 INFO - operating with platform_type : linux_ 10:46:56 INFO - Initialising browser for kraken test... 10:46:56 INFO - TEST-INFO | started process 23377 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkCGzbY/profile http://localhost:50394/getInfo.html) 10:47:00 INFO - PROCESS | 23377 | __metrics Screen width/height:1600/1200 10:47:00 INFO - PROCESS | 23377 | colorDepth:24 10:47:00 INFO - PROCESS | 23377 | Browser inner width/height: 1024/697 10:47:00 INFO - PROCESS | 23377 | __metrics 10:47:00 INFO - PROCESS | 23377 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 10:47:00 INFO - PROCESS | 23377 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:47:01 INFO - PROCESS | 23377 | console.error: PushService: 10:47:01 INFO - PROCESS | 23377 | stateChangeProcessEnqueue: Error transitioning state 10:47:01 INFO - PROCESS | 23377 | UnknownError 10:47:02 INFO - TEST-INFO | 23377: exit 0 10:47:02 INFO - Browser initialized. 10:47:02 INFO - Running cycle 1/1 for kraken test... 10:47:02 INFO - TEST-INFO | started process 23460 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkCGzbY/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:47:14 INFO - PROCESS | 23460 | RSS: Main: 174391296 10:47:14 INFO - PROCESS | 23460 | 10:47:16 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50394/tests/kraken/driver.html?testName=audio-beat-detection) 10:47:17 INFO - PROCESS | 23460 | RSS: Main: 239697920 10:47:17 INFO - PROCESS | 23460 | 10:47:20 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50394/tests/kraken/driver.html?testName=audio-dft) 10:47:20 INFO - PROCESS | 23460 | RSS: Main: 218259456 10:47:20 INFO - PROCESS | 23460 | 10:47:24 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50394/tests/kraken/driver.html?testName=audio-fft) 10:47:24 INFO - PROCESS | 23460 | RSS: Main: 299388928 10:47:24 INFO - PROCESS | 23460 | 10:47:26 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50394/tests/kraken/driver.html?testName=audio-oscillator) 10:47:27 INFO - PROCESS | 23460 | RSS: Main: 211365888 10:47:27 INFO - PROCESS | 23460 | 10:47:29 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50394/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:47:30 INFO - PROCESS | 23460 | RSS: Main: 214564864 10:47:30 INFO - PROCESS | 23460 | 10:47:33 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50394/tests/kraken/driver.html?testName=imaging-darkroom) 10:47:33 INFO - PROCESS | 23460 | RSS: Main: 249843712 10:47:33 INFO - PROCESS | 23460 | 10:47:36 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50394/tests/kraken/driver.html?testName=imaging-desaturate) 10:47:37 INFO - PROCESS | 23460 | RSS: Main: 249778176 10:47:37 INFO - PROCESS | 23460 | 10:47:40 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50394/tests/kraken/driver.html?testName=json-parse-financial) 10:47:40 INFO - PROCESS | 23460 | RSS: Main: 248508416 10:47:40 INFO - PROCESS | 23460 | 10:47:42 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50394/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:47:42 INFO - PROCESS | 23460 | RSS: Main: 211435520 10:47:42 INFO - PROCESS | 23460 | 10:47:44 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:47:45 INFO - PROCESS | 23460 | RSS: Main: 218173440 10:47:45 INFO - PROCESS | 23460 | 10:47:47 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:47:47 INFO - PROCESS | 23460 | RSS: Main: 227377152 10:47:47 INFO - PROCESS | 23460 | 10:47:50 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:47:51 INFO - PROCESS | 23460 | RSS: Main: 231542784 10:47:51 INFO - PROCESS | 23460 | 10:47:54 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:47:54 INFO - PROCESS | 23460 | RSS: Main: 233631744 10:47:54 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | Cycle 1(1): loaded http://localhost:50394/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50394/tests/kraken/driver.html?testName=ai-astar) 10:47:56 INFO - PROCESS | 23460 | RSS: Main: 284344320 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | __start_tp_report 10:47:56 INFO - PROCESS | 23460 | _x_x_mozilla_page_load 10:47:56 INFO - PROCESS | 23460 | _x_x_mozilla_page_load_details 10:47:56 INFO - PROCESS | 23460 | |i|pagename|runs| 10:47:56 INFO - PROCESS | 23460 | |0;ai-astar;104;113;112;112;112;113;114;113;112;110 10:47:56 INFO - PROCESS | 23460 | |1;audio-beat-detection;149;127;130;169;127;129;126;123;158;121 10:47:56 INFO - PROCESS | 23460 | |2;audio-dft;160;162;160;161;162;162;162;159;161;162 10:47:56 INFO - PROCESS | 23460 | |3;audio-fft;75;77;77;106;77;76;76;75;97;75 10:47:56 INFO - PROCESS | 23460 | |4;audio-oscillator;83;83;123;83;82;82;103;82;82;115 10:47:56 INFO - PROCESS | 23460 | |5;imaging-gaussian-blur;117;117;116;117;117;117;117;117;116;116 10:47:56 INFO - PROCESS | 23460 | |6;imaging-darkroom;146;146;146;148;146;146;146;146;146;146 10:47:56 INFO - PROCESS | 23460 | |7;imaging-desaturate;84;84;85;84;84;85;85;84;84;84 10:47:56 INFO - PROCESS | 23460 | |8;json-parse-financial;54;53;54;53;56;55;55;54;55;54 10:47:56 INFO - PROCESS | 23460 | |9;json-stringify-tinderbox;61;62;61;60;62;61;61;61;61;62 10:47:56 INFO - PROCESS | 23460 | |10;stanford-crypto-aes;80;80;79;79;89;79;85;80;85;80 10:47:56 INFO - PROCESS | 23460 | |11;stanford-crypto-ccm;131;139;134;132;127;129;133;152;192;128 10:47:56 INFO - PROCESS | 23460 | |12;stanford-crypto-pbkdf2;163;164;166;161;168;162;167;160;159;163 10:47:56 INFO - PROCESS | 23460 | |13;stanford-crypto-sha256-iterative;63;66;64;63;64;62;63;63;65;66 10:47:56 INFO - PROCESS | 23460 | __end_tp_report 10:47:56 INFO - PROCESS | 23460 | __start_cc_report 10:47:56 INFO - PROCESS | 23460 | _x_x_mozilla_cycle_collect,1675 10:47:56 INFO - PROCESS | 23460 | __end_cc_report 10:47:56 INFO - PROCESS | 23460 | __startTimestamp1477936076581__endTimestamp 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | ------- Summary: start ------- 10:47:56 INFO - PROCESS | 23460 | Number of tests: 14 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#0] ai-astar Cycles:10 Average:111.50 Median:112.50 stddev:2.84 (2.5%) stddev-sans-first:1.12 10:47:56 INFO - PROCESS | 23460 | Values: 104.0 113.0 112.0 112.0 112.0 113.0 114.0 113.0 112.0 110.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#1] audio-beat-detection Cycles:10 Average:135.90 Median:129.50 stddev:16.61 (12.8%) stddev-sans-first:16.93 10:47:56 INFO - PROCESS | 23460 | Values: 149.0 127.0 130.0 169.0 127.0 129.0 126.0 123.0 158.0 121.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#2] audio-dft Cycles:10 Average:161.10 Median:162.00 stddev:1.10 (0.7%) stddev-sans-first:1.09 10:47:56 INFO - PROCESS | 23460 | Values: 160.0 162.0 160.0 161.0 162.0 162.0 162.0 159.0 161.0 162.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#3] audio-fft Cycles:10 Average:81.10 Median:76.50 stddev:10.99 (14.4%) stddev-sans-first:11.43 10:47:56 INFO - PROCESS | 23460 | Values: 75.0 77.0 77.0 106.0 77.0 76.0 76.0 75.0 97.0 75.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#4] audio-oscillator Cycles:10 Average:91.80 Median:82.00 stddev:15.82 (19.3%) stddev-sans-first:16.46 10:47:56 INFO - PROCESS | 23460 | Values: 83.0 83.0 123.0 83.0 82.0 82.0 103.0 82.0 82.0 115.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 10:47:56 INFO - PROCESS | 23460 | Values: 117.0 117.0 116.0 117.0 117.0 117.0 117.0 117.0 116.0 116.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 10:47:56 INFO - PROCESS | 23460 | Values: 146.0 146.0 146.0 148.0 146.0 146.0 146.0 146.0 146.0 146.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#7] imaging-desaturate Cycles:10 Average:84.30 Median:84.00 stddev:0.48 (0.6%) stddev-sans-first:0.50 10:47:56 INFO - PROCESS | 23460 | Values: 84.0 84.0 85.0 84.0 84.0 85.0 85.0 84.0 84.0 84.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#8] json-parse-financial Cycles:10 Average:54.30 Median:54.50 stddev:0.95 (1.7%) stddev-sans-first:1.00 10:47:56 INFO - PROCESS | 23460 | Values: 54.0 53.0 54.0 53.0 56.0 55.0 55.0 54.0 55.0 54.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#9] json-stringify-tinderbox Cycles:10 Average:61.20 Median:61.00 stddev:0.63 (1.0%) stddev-sans-first:0.67 10:47:56 INFO - PROCESS | 23460 | Values: 61.0 62.0 61.0 60.0 62.0 61.0 61.0 61.0 61.0 62.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#10] stanford-crypto-aes Cycles:10 Average:81.60 Median:80.00 stddev:3.47 (4.3%) stddev-sans-first:3.63 10:47:56 INFO - PROCESS | 23460 | Values: 80.0 80.0 79.0 79.0 89.0 79.0 85.0 80.0 85.0 80.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#11] stanford-crypto-ccm Cycles:10 Average:139.70 Median:133.50 stddev:19.75 (14.8%) stddev-sans-first:20.70 10:47:56 INFO - PROCESS | 23460 | Values: 131.0 139.0 134.0 132.0 127.0 129.0 133.0 152.0 192.0 128.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.30 Median:163.50 stddev:2.98 (1.8%) stddev-sans-first:3.16 10:47:56 INFO - PROCESS | 23460 | Values: 163.0 164.0 166.0 161.0 168.0 162.0 167.0 160.0 159.0 163.0 10:47:56 INFO - PROCESS | 23460 | 10:47:56 INFO - PROCESS | 23460 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.90 Median:64.00 stddev:1.37 (2.1%) stddev-sans-first:1.41 10:47:56 INFO - PROCESS | 23460 | Values: 63.0 66.0 64.0 63.0 64.0 62.0 63.0 63.0 65.0 66.0 10:47:56 INFO - PROCESS | 23460 | -------- Summary: end -------- 10:47:56 INFO - PROCESS | 23460 | 10:47:57 INFO - TEST-INFO | 23460: exit 0 10:47:57 INFO - TEST-OK | kraken | took 61616ms 10:47:57 INFO - SUITE-END | took 1178s 10:47:58 INFO - Completed test suite (00:19:38) 10:47:58 INFO - javascript benchmark 10:47:58 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2922.1379692990567, 2930.930210473175, 2973.1229287360225, 2981.3739114785894, 2989.6262967129096, 5114.207297868827, 5179.860430705248, 5287.0, 5352.06338890694, 5410.16142497913, 5214.348206474191, 5254.316938797961, 5327.121025030865, 5334.5999050071205, 5387.353517577886, 4761.119192949298, 4776.402949631296, 4815.951840481603, 4827.951720482785, 4870.951290487085, 4896.1186986342445, 4914.705117692932, 4946.653734238586, 4947.03532811102, 5005.074061298671, 4648.651351148644, 4891.9755401222765, 4906.411230652345, 4927.6797008194535, 5013.398392192924, 4696.765161741933, 4752.691075080109, 4772.117158325721, 4819.349387832668, 4830.541098595628, 4781.713097214179, 4783.617310615143, 4789.353437285957, 4837.201861692816, 4858.416989961192, 5273.0, 5315.202719592092, 5326.440723723992, 5330.227117068003, 5332.493413125747, 5471.753771080311, 5489.1217405214975, 5587.0, 5615.494605485485, 5627.8593035174035, 5658.0381335173115, 5682.602217844753, 5686.914696279559, 5737.311522617271, 5756.942430575725, 5295.443978382253, 5303.257543943851, 5306.044911915892, 5306.09796334624, 5306.416294207634, 5530.5852061095575, 5570.387257401682, 5750.769969201268, 5774.0, 5812.82561523155, 5556.055470570012, 5595.720213989365, 5604.411536788579, 5668.348139963874, 5672.177534257509, 5643.068893632505, 5645.915311270334, 5679.460451257124, 5696.401877802771, 5698.401667824902, 5453.291072160673, 5484.177373394023, 5666.376698563155, 5684.204211410406, 5687.914681279784, 5517.144842549331, 5552.111662134039, 5562.888742225133, 5572.693501857356, 5647.491725744702, 4302.139572085595, 4309.84915527955, 4311.611954924009, 4345.435093437833, 4401.823927042947, 3856.4022576500124, 3870.632289932452, 3873.6320049595242, 3909.081365879016, 3919.6668283195677, 5171.896562068738, 5224.373075230997, 5326.573874090063, 5351.224072509464, 5374.167004114369, 5689.288838895138, 5710.71446427677, 5711.7144142792695, 5714.085746280575, 5768.942310576925, 5339.359276886798, 5384.6769193848495, 5386.192071189353, 5387.218853266255, 5387.81142660005, 4738.976305118453, 4788.545088216614, 4834.371531700856, 4872.610191184696, 4943.752812359367, 5875.265591801025, 5878.3239927408895, 5885.5585831062845, 5918.7928422505, 5948.048312270016, 5636.520895723909, 5647.29408823897, 5650.378458369658, 5652.915206271827, 5653.745581448762, 5682.9147562785765, 5729.1119876419225, 5805.448482394166, 5834.241548598655, 5876.853078673067, 5535.39110697831, 5598.188262701967, 5600.803971860965, 5637.351704554028, 5653.689047102449, 5626.099824028136, 5637.774489020558, 5682.829515114553, 5688.288963879515, 5690.971545142248, 5407.297051383295, 5481.561475081904, 5581.469760372758, 5581.49766521015, 5592.69240191777, 5504.0, 5536.031194540858, 5550.0, 5565.3599836019375, 5626.24045753818, 5499.780008799603, 5539.8892022160135, 5544.251526044094, 5546.500814926676, 5558.360788509373, 5419.539339156058, 5605.5795815313195, 5607.719614019201, 5611.943880561143, 5676.318841739017, 5342.278792363137, 5424.484673955968, 5454.290942177491, 5479.753411096431, 5544.306961629796], "value": 5215.00198347376, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [555.8616587106935, 588.9146073819295, 608.3460280198788, 622.7166639179173, 662.6355504472539, 30704.692953070462, 41423.993520939446, 42678.14643707128, 42682.359764603556, 42684.14631707364, 44262.336064959054, 44688.0, 45006.54993450065, 45052.774736126354, 45060.549394506044, 7915.445918785687, 8799.648014079445, 8949.373543851932, 8949.686760963368, 8957.776055598597, 7927.28654421102, 10387.065164135227, 10658.253922225409, 10659.680209593686, 11014.559417623326, 10865.45672716361, 10898.945505272462, 10915.617953371633, 10925.726856828564, 10931.836022459669, 10556.78886422275, 10568.947155264252, 10619.36283822973, 10629.9468502657, 10636.149108071375, 10546.789064218749, 10601.151907847354, 10624.30941988776, 10627.0, 10630.30902991303, 41718.37422438666, 42043.0, 42054.78972605148, 42070.36894446586, 42093.15813683709, 3446.9310613787834, 3555.964440355615, 3703.8703645372284, 3951.6443520083044, 4134.607212314825, 30645.540316895265, 31473.0, 31510.212244693837, 31638.367232655448, 32032.519512207335, 4250.171216612762, 4409.559044095597, 4525.524819893897, 4559.270516717309, 4607.815687372501, 311813.0, 314949.0, 315082.0, 316269.41865290754, 317358.0, 33061.66938330634, 33238.0, 33788.0, 55024.449755502734, 55456.44543554513, 35354.0, 35380.64619353825, 35497.46753798695, 35502.28995420077, 35513.28973420517, 15057.924710376377, 15176.468823591122, 15183.240837958057, 15270.770938435933, 15282.923585382003, 11388.20282580228, 11684.18210725241, 12461.252324860538, 12891.097623166288, 12907.483700652057, 8026.799330016796, 8130.75607731769, 8175.959120204361, 8267.29727973117, 8294.29498492635, 3151.275206702471, 3183.4906414973957, 3210.9839450803065, 3260.3805276997296, 3278.5901762279714, 997.2670087485692, 1007.6171054999054, 1018.8879223285433, 1041.1358572384902, 1103.8013157631542, 30374.69625303763, 30745.538816917764, 30978.22554436112, 31070.22324441907, 31174.376512469622, 1094.1520321750706, 1139.8575178102737, 1160.8955194032408, 1175.9470823812949, 1211.684961909892, 15997.0, 16394.0, 16643.750343744854, 16653.50039498817, 16852.32590696383, 516437.0, 521713.0, 521713.0, 523849.0, 524028.0, 56411.0, 56912.43087569071, 56922.0, 56946.145807812914, 56970.43029569651, 1171.2035815645272, 1245.8567264764488, 1264.6522206393315, 1299.8635143309816, 1354.038632570866, 29507.262318442212, 30896.382072358876, 31821.20446988844, 32111.518327224643, 32311.0, 47144.7642761784, 47800.52199477961, 47933.76033119812, 47947.0, 47963.76018119887, 357258.0, 358902.0, 359397.0, 359462.0, 359623.2018839889, 26340.20979370622, 26761.197164085108, 26850.06024789123, 28195.295117622223, 28438.85780571084, 44536.77731611321, 45013.32480012737, 45280.77359613181, 45323.77338113288, 45611.54388456073, 38521.422178666784, 38711.6128838708, 39042.80478597702, 39164.6083539161, 40192.0, 38708.225835483696, 38840.41739373855, 39318.28180618344, 39741.0, 40323.59676403199, 38797.6120238794, 39206.215875682894, 39313.13737252504, 40158.397624036246, 40277.0, 33160.834195828866, 34331.31337373288, 34714.9585512435, 35339.823300883334, 35742.64257357497, 26676.59985100264, 26834.463310733285, 27240.72759272382, 27302.0, 27496.725032749415], "value": 18623.04583738975, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [372.9608391118934, 394.26469634132354, 397.6103418649723, 406.6990427083958, 416.15642702826466, 13456.0, 15572.688546229083, 17228.82771172288, 19518.902405487952, 19805.900970495128, 19316.420507384766, 19512.31706890259, 19692.310769123083, 19898.10458529366, 19921.501962450948, 4513.954860451403, 5483.725813709329, 5672.574556908227, 5702.7433765480655, 5710.257666503348, 4097.7541347519245, 4327.826886924535, 5677.148427735852, 5732.140178973166, 5769.798057068004, 6041.335453100155, 6413.198350206224, 6425.389587989133, 6517.543771935966, 6531.51013673974, 6289.496840252768, 6402.327755585667, 6439.871202575969, 6440.774572889974, 6539.313372095933, 5672.858178545569, 5675.858103547403, 5680.176374425727, 5681.573881958829, 5700.116481945305, 20989.68515472269, 21927.780722192732, 22161.44596385087, 23150.42123946898, 23161.53676926452, 2407.2898494944034, 2507.360623041113, 2566.5508536006123, 2693.2189664997322, 2906.3606006678497, 10363.585456581728, 10661.786764264749, 13092.149010314395, 13738.65653358674, 14218.786718199235, 1891.1206289075508, 1943.7667479902361, 1944.0959953621634, 1955.599102184049, 1987.8111579399933, 68437.78746550446, 75491.24508754897, 77627.6118619409, 81291.18708812895, 81359.5932020336, 10635.361878287173, 10725.570977160982, 10801.351918884891, 10922.781544369227, 11042.558297668003, 15416.304206537272, 15452.291450052131, 15452.5364239073, 15529.45646902353, 15550.0, 7585.848283034419, 7759.7672069838, 7850.371970242367, 7890.526568405914, 8052.516848989079, 7409.110906691124, 7451.3293803557945, 7499.925000750031, 7516.849663006709, 7624.618769061524, 4684.718916864999, 4696.506866778939, 4708.623310135181, 4724.929126063112, 4829.830955916526, 1823.2433540080717, 1863.5154859736567, 1918.1080797428983, 1958.7159861819957, 2003.6393449179288, 827.7061643116607, 962.1244667352676, 992.0426788149326, 1003.5684655598163, 1057.3021805608262, 18849.434516964513, 19313.0, 19416.320428785206, 19490.512737181685, 19888.50278743043, 953.7663272498282, 980.3725615606018, 1004.1013293102632, 1007.7682133109425, 1032.6850310655173, 10235.641752538775, 10874.782504349869, 10969.0, 11033.172512061628, 11071.114310855111, 457204.0, 464650.0, 464736.0, 465562.0, 470183.0, 85673.57163214144, 86648.0, 88452.0, 88766.78632495663, 90473.0, 1002.9147522460672, 1018.760591261053, 1032.4218437674776, 1050.56926660069, 1054.2356791326226, 16115.274812633224, 16593.41923032688, 17022.0, 17296.567585810455, 17543.912280438515, 40464.79767601143, 41408.0, 41527.792361038, 41602.37596436116, 41750.16499670051, 54248.45751542434, 55612.72193639006, 56383.71808140933, 56416.43583564112, 56565.0, 8281.668733250603, 8388.286995605442, 8530.274926631058, 8551.871721924052, 8716.477011379338, 9547.09058188379, 12459.688507787378, 13034.739305213652, 13153.145045572008, 13233.735325293634, 11298.322100673986, 11697.590584329508, 11770.82343764827, 11826.526938922347, 12109.0, 11287.548498059985, 11366.261193022427, 11510.884891150981, 11685.298882067103, 11869.287842729464, 11217.66347009591, 11377.772444551229, 11564.132690048113, 11654.533818647498, 12207.69480762988, 7999.4400391972, 8148.633311501115, 8605.0, 8671.132886711279, 8772.078931712078, 10136.0, 10886.891131088587, 10921.180911431833, 11116.833247501132, 11695.649130526097], "value": 9159.506370779509, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1487.4868170481186, 1516.628426035621, 1670.9749353759696, 1773.9379121730742, 1813.3109418420997, 7577.507462014965, 7841.4118941079505, 8133.146019667938, 8673.91326086739, 8673.91326086739, 8128.146544612804, 8434.114417986115, 8462.280706139985, 8662.610182541785, 8731.912680873189, 2220.5003874128315, 2256.650219216024, 2256.7968882800546, 2261.9886900565475, 2282.532080923415, 1998.1807458941837, 2225.7996780289773, 2261.3442101790542, 2282.7717228277206, 2286.6455699366543, 2009.447401964457, 2161.945951351221, 2244.3267019894047, 2251.6960210371553, 2263.9773602264013, 2214.1807531213394, 2220.844540882139, 2224.710787597602, 2233.336164557407, 2247.910083596654, 2201.7027701260445, 2218.190360518415, 2224.7219097612797, 2232.0960011195493, 2234.2626933112197, 8571.14288571144, 8613.095624959415, 8685.913140868573, 8687.305015598737, 8702.042775294713, 4851.636127290467, 4948.925766113512, 5068.341115654941, 5070.645054846163, 5072.416672082684, 3264.6245681746427, 3324.517944898, 3452.9654703452893, 3467.9826600866836, 3471.340445315407, 1087.6302057300477, 1095.649392194498, 1145.6906635208447, 1154.4747140051256, 1157.2477889371892, 11967.700807479796, 11974.940125299405, 11977.401129943468, 11997.640070797803, 12000.819987700192, 4216.283231850532, 4495.842645507457, 4508.729476231437, 4540.205464043779, 4540.364348991144, 10042.799144017225, 10059.497025148714, 10063.345882517613, 10067.1442927352, 10072.244581656405, 5105.642605017613, 5106.387233532, 5112.488751124858, 5117.283580298761, 5128.384593848762, 4612.838550650778, 4639.095376401637, 4653.604443622262, 4697.81208751653, 4713.78787954536, 3723.255348930171, 3768.717346199046, 3844.2888065707934, 3863.439801228806, 3891.3190191716335, 1087.3693257910393, 1199.3883119609063, 1201.1531870031606, 1214.4170798017, 1223.473906220334, 803.6504120707394, 923.0, 930.7580029192324, 937.1706040154512, 944.5230158769915, 5546.722663866791, 5671.432856714296, 5682.829515114553, 5698.344690360579, 5702.0, 925.4031149908271, 971.8930917599058, 1010.0757806606872, 1010.242318261304, 1018.6994836523244, 3735.364987952055, 3767.868124615625, 3818.1790914953417, 3819.52255968004, 3851.287511810324, 10489.580416783396, 10644.680659580225, 10758.139348852073, 10767.515461804238, 10815.026647601597, 10612.20408469368, 10646.467676616137, 10672.359658420519, 10697.251192416456, 10717.196210284259, 7410.481266311414, 7717.459777815499, 8082.555459449787, 8188.467749596257, 8231.588420578948, 5749.8275051748515, 5755.424457554211, 5839.503642190291, 5861.35525092248, 5944.8811023780145, 9537.14165725088, 9598.280128990215, 9649.855252171363, 9737.464439455614, 9922.900770992197, 9841.60633574649, 9861.359011664219, 9957.0, 9967.700968970943, 10065.899341006496, 7259.165196002527, 7510.662020209213, 7617.542947423172, 7741.690332386642, 7765.0681918170185, 8141.552214628252, 8263.0, 8279.95860020696, 8281.792955176168, 8292.543910084762, 6884.690188941409, 6984.511084224056, 7155.713771449292, 7318.743843965436, 7415.777526674208, 7055.470839686941, 7134.46491513149, 7186.245444228281, 7265.9273407265255, 7301.452391070585, 6434.710438030206, 6436.678166091583, 6489.805305840832, 6502.154719886385, 6513.772017979538, 4689.953100468952, 4692.272697731857, 4714.057188562233, 4723.6929599575915, 4756.785944632431, 4567.1550763108935, 4599.988002639414, 4629.444466664022, 4763.857084287477, 4798.160321943716], "value": 4474.951786136259, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [292.1702365282598, 305.6301874731575, 307.93071558899237, 310.2878892940702, 310.69862233633376, 5219.478052194788, 5253.268300483746, 5293.629445938776, 5351.2775775270375, 5360.517553420192, 5119.0, 5189.195674670423, 5203.609729270301, 5212.061828870802, 5246.475352464751, 4090.9590904091024, 4095.201435720036, 4108.342665173573, 4109.383592461125, 4161.563035881234, 3845.692344612424, 4045.919081618366, 4126.730298335903, 4130.483689538808, 4157.189348077126, 4040.979795101035, 4046.8988275293204, 4050.23045621331, 4051.5948405159397, 4061.370487574416, 4033.757974521538, 4037.1320166164123, 4043.9687879590515, 4044.6157615026527, 4072.5112986441522, 3566.4293713006055, 3573.356795776759, 3573.4818451324672, 3578.284343131358, 3587.192881601645, 5123.769430375642, 5128.384593848725, 5161.896762064775, 5185.948140518584, 5188.325517682715, 4636.724900652314, 4639.907201855944, 4649.814297354153, 4673.205555055615, 4677.4854765975715, 5484.780608775644, 5494.0, 5496.120620700669, 5508.55931525477, 5527.944720552783, 3800.9429858552144, 3869.7097717671286, 3877.8836634901, 3881.2237552489614, 3896.5518965319066, 5687.658740475544, 5718.711740749086, 5723.54211663066, 5727.255456790632, 5732.0, 3965.6629186518894, 3966.345552983783, 3967.821448034845, 3972.5431575369203, 4003.919921601552, 3939.527256729211, 3988.481497405319, 3996.3424322825576, 4013.1973605279063, 4042.0, 4605.65457590682, 4606.815727370935, 4619.815207391666, 4621.214393553104, 4630.629549636021, 5538.778448862081, 5570.944290557123, 5607.495325420732, 5611.9719401403545, 5664.51851592611, 1312.4356526693614, 1319.469415478041, 1337.2177276293282, 1339.2834833364298, 1366.863313668625, 910.9453432794054, 923.215267023025, 938.2915898496591, 939.6006697153819, 945.8723072385278, 5286.5506431952945, 5313.415524292324, 5319.893602127936, 5341.4925582069645, 5358.356997160366, 5565.554755619541, 5580.944190558123, 5593.860153496195, 5648.717564121777, 5662.518685911661, 5109.310243117132, 5331.653442526223, 5334.546563542065, 5347.51872331492, 5383.16560933056, 3005.6543497497632, 3025.909222723322, 3029.6822930458216, 3032.757379409642, 3040.315928915976, 5898.8230353089475, 5902.911456328158, 5921.881562368729, 5928.377520360386, 5935.940640593625, 5563.805266815642, 5714.000149921241, 5761.279840019997, 5772.0, 5779.248697669276, 5853.64878107315, 5873.353931067579, 5883.58793889472, 5926.970365148147, 5936.0, 5456.236126942152, 5652.98637967048, 5662.8018019370775, 5693.975084484832, 5704.572157088152, 5634.915476267777, 5640.210370548045, 5650.943490565041, 5663.9716801415725, 5669.270872383962, 5912.320083190316, 5929.695466997254, 5943.286805583358, 5955.9577074011, 5975.880482390241, 3864.9227015460096, 3874.49631547897, 3895.24042811649, 3908.159745654698, 3916.118873253495, 5444.8366549003595, 5665.376808551138, 5720.885582288414, 5722.914156287742, 5732.856678583069, 5511.429242665821, 5512.503874651301, 5564.8330550083565, 5566.053770858883, 5578.246936663661, 5535.446455354593, 5537.446255374592, 5570.944290557042, 5573.8606534835335, 5582.609217354746, 5368.308982670446, 5501.752421140978, 5542.473465020817, 5554.50009499147, 5581.944180558305, 5568.638038527482, 5587.944120558743, 5596.18855265976, 5610.943890561042, 5611.691356975405, 5482.671039737628, 5483.0, 5502.174673798962, 5507.284053073075, 5529.889402212014], "value": 4192.39937270268, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [725.9201487836339, 750.9224263182331, 762.5920132728987, 773.9342155916745, 819.7458787775786, 14576.489822856201, 14925.179115148663, 15224.314905829237, 15494.767578486317, 15660.84339156608, 13295.0, 13498.190108593466, 13519.053666243366, 13541.119827211225, 13649.72700545991, 809.4778867630375, 820.2412768189431, 830.0869044051556, 830.7175560309523, 831.4678605692332, 669.5681285570804, 680.4556354916048, 805.1304591041691, 818.2186012358184, 835.2357592802579, 868.3313848336777, 874.1608056265992, 874.2699845628907, 876.2464280718577, 876.3164731509432, 867.822096470222, 870.8998465176522, 871.4509858788954, 871.5337294547419, 871.6426265231288, 515.1217174717099, 525.1099386539817, 615.6244690738646, 625.5902383938527, 635.0093853588417, 14539.927300363537, 14731.926340368336, 14741.336639851232, 14755.336009879582, 14764.852351476455, 12839.935800320938, 13187.736245275137, 13590.59228223155, 13695.520656777064, 13707.588772336845, 11781.293122412682, 11933.94033029838, 12160.878391216063, 12231.266124032587, 12262.141650084497, 4325.545817689129, 4366.432363792686, 4387.407699960497, 4408.272635015219, 4413.713108647928, 59587.40412595905, 59699.53755780528, 60081.69959150176, 62725.0, 63395.97738214862, 9793.0, 10357.63748268807, 10519.894801052045, 10575.312604680672, 10679.412632305297, 19256.614867702567, 19501.219951202078, 19523.0, 19732.210711571377, 19995.900020500096, 7597.772066838003, 7733.535987840747, 7789.454738168274, 7933.286004259644, 8105.027396712432, 4624.861254162381, 4625.236835922035, 4737.1236321279985, 4783.6651434399255, 4851.733154676526, 3352.6814952579466, 3448.74134439913, 3461.1866211440292, 3475.565554305712, 3484.0, 598.1685457214476, 648.0570769530322, 670.5741853922697, 674.2448457727279, 679.0255982664793, 623.0467384901109, 665.8734840380313, 709.1277728394001, 715.5492040014861, 747.3535391885979, 9373.953130234306, 9426.151646351724, 9587.616495340108, 9657.46883921391, 9761.121499065119, 584.5294537896949, 652.4160876015939, 722.2272168779356, 728.7012324946852, 756.5120497279335, 4464.419625448736, 4603.194440972817, 4757.952420475751, 4816.301636262722, 4822.758862056883, 51614.709352316946, 52741.208881866805, 52868.471315286355, 53458.0, 53544.19683704748, 48202.0, 61105.38894610997, 64098.0385294221, 78328.0, 79539.0, 41251.793741031106, 52297.215541766906, 55780.721096394256, 61790.382096178466, 65153.67423162854, 9372.95313523428, 9889.307748457539, 9981.850272246067, 10082.546285417027, 10133.189344852246, 42041.0, 43260.30375253009, 45151.0, 45479.77260113811, 45816.0, 56915.0, 61062.38937610567, 61389.40548323149, 62504.374956251675, 62613.686931566874, 12035.638930832089, 12235.449404776984, 12279.815802763145, 12298.877011229773, 12791.168574042658, 12968.740625187633, 13827.930860345634, 13829.585112446643, 14066.859331406555, 14073.225972571197, 13101.0, 13198.80201796993, 13359.198448092757, 13519.0, 14146.43414263459, 12704.237745735285, 13014.349282535646, 13124.671883202996, 13654.86345136536, 13659.521916732867, 12818.359082046047, 13219.933900330438, 13508.932455337661, 13805.930970345084, 13948.372323245276, 10218.437985910847, 10474.214433917334, 10627.095257308756, 10630.681079567625, 10682.946585267024, 10700.30448020876, 10840.67477975662, 10848.945755271174, 11057.5024123913, 11186.0], "value": 6986.243301678653, "unit": "score"}], "name": "dromaeo_css", "value": 6989.605463764434, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 113.0, 112.0, 112.0, 112.0, 113.0, 114.0, 113.0, 112.0, 110.0], "value": 111.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 127.0, 130.0, 169.0, 127.0, 129.0, 126.0, 123.0, 158.0, 121.0], "value": 135.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 162.0, 160.0, 161.0, 162.0, 162.0, 162.0, 159.0, 161.0, 162.0], "value": 161.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 77.0, 106.0, 77.0, 76.0, 76.0, 75.0, 97.0, 75.0], "value": 81.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 123.0, 83.0, 82.0, 82.0, 103.0, 82.0, 82.0, 115.0], "value": 91.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 116.0, 116.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 148.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0], "value": 146.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 85.0, 84.0, 84.0, 85.0, 85.0, 84.0, 84.0, 84.0], "value": 84.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 53.0, 54.0, 53.0, 56.0, 55.0, 55.0, 54.0, 55.0, 54.0], "value": 54.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 62.0, 61.0, 60.0, 62.0, 61.0, 61.0, 61.0, 61.0, 62.0], "value": 61.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 80.0, 79.0, 79.0, 89.0, 79.0, 85.0, 80.0, 85.0, 80.0], "value": 81.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 139.0, 134.0, 132.0, 127.0, 129.0, 133.0, 152.0, 192.0, 128.0], "value": 139.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 166.0, 161.0, 168.0, 162.0, 167.0, 160.0, 159.0, 163.0], "value": 163.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 66.0, 64.0, 63.0, 64.0, 62.0, 63.0, 63.0, 65.0, 66.0], "value": 63.9, "unit": "score"}], "name": "kraken", "value": 1492.6, "alertThreshold": 2.0}]} 10:47:58 INFO - Return code: 0 10:47:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:47:58 INFO - # TBPL SUCCESS # 10:47:58 INFO - Running post-action listener: _resource_record_post_action 10:47:58 INFO - [mozharness: 2016-10-31 17:47:58.378685Z] Finished run-tests step (success) 10:47:58 INFO - Running post-run listener: _resource_record_post_run 10:47:58 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 4096; Write bytes: 399581184; Read time: 12; Write time: 289508 10:47:58 INFO - TinderboxPrint: CPU usage
13.0% 10:47:58 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 10:47:58 INFO - TinderboxPrint: I/O write bytes / time
399,581,184 / 289,508 10:47:58 INFO - TinderboxPrint: CPU idle
8,301.5 (87.0%) 10:47:58 INFO - TinderboxPrint: CPU user
1,190.6 (12.5%) 10:47:58 INFO - TinderboxPrint: Swap in / out
0 / 0 10:47:58 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 110161920; Read time: 0; Write time: 74460 10:47:58 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 0; Write bytes: 288456704; Read time: 0; Write time: 215024 10:47:59 INFO - Running post-run listener: _upload_blobber_files 10:47:59 INFO - Blob upload gear active. 10:47:59 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:47:59 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 10:47:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:47:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:47:59 INFO - (blobuploader) - INFO - Open directory for files ... 10:47:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:47:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:47:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:48:03 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:48:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:48:03 INFO - (blobuploader) - INFO - Done attempting. 10:48:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 10:48:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:48:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:48:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 10:48:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:48:03 INFO - (blobuploader) - INFO - Done attempting. 10:48:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 10:48:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:48:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:48:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 10:48:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:48:04 INFO - (blobuploader) - INFO - Done attempting. 10:48:04 INFO - (blobuploader) - INFO - Iteration through files over. 10:48:04 INFO - Return code: 0 10:48:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:48:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:48:04 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b981fe3bebaf94bca13facfb4d2321c0e8466bdae2a070641f1c3c9b1e7d1200fff991532e4259c48e754033dd71fd171a469a85243fd500a9954f2f597a5f21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b66ab3cbd96ae491126a39ae38cdba47e05d7ec4c9c35cc99ef4245e2d66c72bb347eb617348a96901efc5b031db424d200eb4c8843da4980a6364c3947d53b7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54882201a0709e1aa6e75774641ba9bb11bc64efd731d95b74641a5c0d4e2c8bbf38e150bebefa4c9f50915cc58c598c3b6f1f68eb28aaa90bc1d3add12c1e05"} 10:48:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:48:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:48:04 INFO - Contents: 10:48:04 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b981fe3bebaf94bca13facfb4d2321c0e8466bdae2a070641f1c3c9b1e7d1200fff991532e4259c48e754033dd71fd171a469a85243fd500a9954f2f597a5f21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b66ab3cbd96ae491126a39ae38cdba47e05d7ec4c9c35cc99ef4245e2d66c72bb347eb617348a96901efc5b031db424d200eb4c8843da4980a6364c3947d53b7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54882201a0709e1aa6e75774641ba9bb11bc64efd731d95b74641a5c0d4e2c8bbf38e150bebefa4c9f50915cc58c598c3b6f1f68eb28aaa90bc1d3add12c1e05"} 10:48:04 INFO - Running post-run listener: copy_logs_to_upload_dir 10:48:04 INFO - Copying logs to upload dir... 10:48:04 INFO - mkdir: /builds/slave/test/build/upload/logs 10:48:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1240.346610 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 40 secs) (at 2016-10-31 10:48:04.591952) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-31 10:48:04.596056) ========= 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=1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b981fe3bebaf94bca13facfb4d2321c0e8466bdae2a070641f1c3c9b1e7d1200fff991532e4259c48e754033dd71fd171a469a85243fd500a9954f2f597a5f21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b66ab3cbd96ae491126a39ae38cdba47e05d7ec4c9c35cc99ef4245e2d66c72bb347eb617348a96901efc5b031db424d200eb4c8843da4980a6364c3947d53b7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54882201a0709e1aa6e75774641ba9bb11bc64efd731d95b74641a5c0d4e2c8bbf38e150bebefa4c9f50915cc58c598c3b6f1f68eb28aaa90bc1d3add12c1e05"} build_url:https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011379 build_url: 'https://queue.taskcluster.net/v1/task/ZlmSvRpTRi-DerMqBFXKbw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b981fe3bebaf94bca13facfb4d2321c0e8466bdae2a070641f1c3c9b1e7d1200fff991532e4259c48e754033dd71fd171a469a85243fd500a9954f2f597a5f21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b66ab3cbd96ae491126a39ae38cdba47e05d7ec4c9c35cc99ef4245e2d66c72bb347eb617348a96901efc5b031db424d200eb4c8843da4980a6364c3947d53b7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/54882201a0709e1aa6e75774641ba9bb11bc64efd731d95b74641a5c0d4e2c8bbf38e150bebefa4c9f50915cc58c598c3b6f1f68eb28aaa90bc1d3add12c1e05"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-31 10:48:04.622071) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:48:04.622508) ========= 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=1f5564757af27664ca02d71f000001b0-1477934842.451968-1319052793 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004637 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-31 10:48:04.704724) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-31 10:48:04.705117) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-31 10:48:04.705542) ========= ========= Total master_lag: 0.17 =========