builder: autoland_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-017 starttime: 1476754689.22 results: success (0) buildid: 20161017183557 builduid: 4d0800976b884a619ab5c659782f7cad revision: d088dafca4fd2c8e4d586f2ffe5947cb09978c00 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.215784) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.216316) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.216603) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.231759) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.232154) ========= 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=0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-17 18:38:09-- 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% 43.1M=0s 2016-10-17 18:38:09 (43.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.145026 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.392385) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.392793) ========= 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=0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013577 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:09.442508) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-17 18:38:09.442869) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev d088dafca4fd2c8e4d586f2ffe5947cb09978c00 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev d088dafca4fd2c8e4d586f2ffe5947cb09978c00 --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=0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-17 18:38:10,055 truncating revision to first 12 chars 2016-10-17 18:38:10,055 Setting DEBUG logging. 2016-10-17 18:38:10,055 attempt 1/10 2016-10-17 18:38:10,055 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/d088dafca4fd?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-17 18:38:11,341 unpacking tar archive at: autoland-d088dafca4fd/testing/mozharness/ program finished with exit code 0 elapsedTime=1.682145 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-17 18:38:11.138360) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:11.138720) ========= script_repo_revision: d088dafca4fd2c8e4d586f2ffe5947cb09978c00 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:11.139134) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:11.139407) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-17 18:38:11.150250) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-10-17 18:38:11.150661) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 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', 'Autoland', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland'] 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=0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:38:11 INFO - MultiFileLogger online at 20161017 18:38:11 in /builds/slave/test 18:38:11 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 18:38:11 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:38:11 INFO - {'append_to_log': False, 18:38:11 INFO - 'base_work_dir': '/builds/slave/test', 18:38:11 INFO - 'blob_upload_branch': 'Autoland', 18:38:11 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:38:11 INFO - 'branch': 'Autoland', 18:38:11 INFO - 'buildbot_json_path': 'buildprops.json', 18:38:11 INFO - 'config_files': ('talos/linux_config.py',), 18:38:11 INFO - 'default_actions': ('clobber', 18:38:11 INFO - 'read-buildbot-config', 18:38:11 INFO - 'download-and-extract', 18:38:11 INFO - 'populate-webroot', 18:38:11 INFO - 'create-virtualenv', 18:38:11 INFO - 'install', 18:38:11 INFO - 'run-tests'), 18:38:11 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:38:11 INFO - 'download_minidump_stackwalk': True, 18:38:11 INFO - 'download_symbols': 'ondemand', 18:38:11 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:38:11 INFO - 'tooltool.py': '/tools/tooltool.py', 18:38:11 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:38:11 INFO - '/tools/misc-python/virtualenv.py')}, 18:38:11 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:38:11 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:38:11 INFO - 'installer_path': 'installer.exe', 18:38:11 INFO - 'log_level': 'info', 18:38:11 INFO - 'log_name': 'talos', 18:38:11 INFO - 'log_to_console': True, 18:38:11 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:38:11 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:38:11 INFO - 'opt_config_files': (), 18:38:11 INFO - 'pip_index': False, 18:38:11 INFO - 'sps_profile': False, 18:38:11 INFO - 'sps_profile_interval': 0, 18:38:11 INFO - 'suite': 'dromaeojs', 18:38:11 INFO - 'system_bits': '32', 18:38:11 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:38:11 INFO - 'title': 'talos-linux64-ix-017', 18:38:11 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:38:11 INFO - 'use_talos_json': True, 18:38:11 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:38:11 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:38:11 INFO - 'work_dir': 'build'} 18:38:11 INFO - [mozharness: 2016-10-18 01:38:11.861483Z] Running clobber step. 18:38:11 INFO - Running pre-action listener: _resource_record_pre_action 18:38:11 INFO - Running main action method: clobber 18:38:11 INFO - rmtree: /builds/slave/test/build 18:38:11 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:38:12 INFO - Running post-action listener: _resource_record_post_action 18:38:12 INFO - [mozharness: 2016-10-18 01:38:12.324137Z] Finished clobber step (success) 18:38:12 INFO - [mozharness: 2016-10-18 01:38:12.324237Z] Running read-buildbot-config step. 18:38:12 INFO - Running pre-action listener: _resource_record_pre_action 18:38:12 INFO - Running main action method: read_buildbot_config 18:38:12 INFO - Using buildbot properties: 18:38:12 INFO - { 18:38:12 INFO - "project": "", 18:38:12 INFO - "product": "firefox", 18:38:12 INFO - "script_repo_revision": "production", 18:38:12 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs", 18:38:12 INFO - "repository": "", 18:38:12 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland pgo talos dromaeojs", 18:38:12 INFO - "buildid": "20161017183557", 18:38:12 INFO - "stage_platform": "linux64-pgo", 18:38:12 INFO - "basedir": "/builds/slave/test", 18:38:12 INFO - "buildnumber": 367, 18:38:12 INFO - "platform": "ubuntu64_hw", 18:38:12 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 18:38:12 INFO - "slavebuilddir": "test", 18:38:12 INFO - "branch": "autoland", 18:38:12 INFO - "revision": "d088dafca4fd2c8e4d586f2ffe5947cb09978c00", 18:38:12 INFO - "slavename": "talos-linux64-ix-017", 18:38:12 INFO - "builduid": "4d0800976b884a619ab5c659782f7cad", 18:38:12 INFO - "repo_path": "integration/autoland" 18:38:12 INFO - } 18:38:12 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 18:38:12 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.test_packages.json. 18:38:12 INFO - Running post-action listener: _resource_record_post_action 18:38:12 INFO - [mozharness: 2016-10-18 01:38:12.326909Z] Finished read-buildbot-config step (success) 18:38:12 INFO - [mozharness: 2016-10-18 01:38:12.326997Z] Running download-and-extract step. 18:38:12 INFO - Running pre-action listener: _resource_record_pre_action 18:38:12 INFO - Running main action method: download_and_extract 18:38:12 INFO - mkdir: /builds/slave/test/build/tests 18:38:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:12 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 18:38:12 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/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 18:38:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/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 18:38:12 INFO - Downloaded 1361 bytes. 18:38:12 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 18:38:12 INFO - Using the following test package requirements: 18:38:12 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 18:38:12 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 18:38:12 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 18:38:12 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'jsshell-linux-x86_64.zip'], 18:38:12 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 18:38:12 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 18:38:12 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 18:38:12 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 18:38:12 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 18:38:12 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 18:38:12 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:38:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 18:38:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:38:12 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 18:38:12 INFO - Http code: 200 18:38:12 INFO - via: 1.1 d2bd759914e30b1d5aee2929535c55f9.cloudfront.net (CloudFront) 18:38:12 INFO - x-amz-cf-id: E0t3CvyEUt2uuBm_fbDnbiomxjEeOW9EopzDfXzoz9CapO9952kDCA== 18:38:12 INFO - x-amz-replication-status: COMPLETED 18:38:12 INFO - x-amz-version-id: 2VfTYACu1Yk_Leqgtix3aQOXLo88XhE6 18:38:12 INFO - Expected file size: 22090390 18:38:12 INFO - Obtained file size: 22090390 18:38:16 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 18:38:16 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 18:38:16 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:38:16 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 18:38:16 INFO - Http code: 200 18:38:16 INFO - via: 1.1 73fa5a1ee49cf827e596b502b5927eab.cloudfront.net (CloudFront) 18:38:16 INFO - x-amz-cf-id: 97ZPmTMvDNlraeoYSN8cXYO9-Cv7Qf99LwrB7loLnsvN4n3y1tyRIw== 18:38:16 INFO - x-amz-replication-status: COMPLETED 18:38:16 INFO - x-amz-version-id: 2VfTYACu1Yk_Leqgtix3aQOXLo88XhE6 18:38:17 INFO - Expected file size: 22090390 18:38:17 INFO - Obtained file size: 22090390 18:38:21 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 18:38:21 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:38:21 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 18:38:21 INFO - Http code: 200 18:38:21 INFO - via: 1.1 d897b81191cbfd68a1b6fc44f98c52b0.cloudfront.net (CloudFront) 18:38:21 INFO - x-amz-cf-id: -HqWU9D4cnXwZXlqA20SgFxFP-oFk6j9962hYJIGoMIJCQJ1zyBZ-Q== 18:38:21 INFO - x-amz-replication-status: COMPLETED 18:38:21 INFO - x-amz-version-id: up3HTbjCtXMrLZmLzU9ktjQ0Eie3sAgS 18:38:21 INFO - Expected file size: 14409028 18:38:21 INFO - Obtained file size: 14409028 18:38:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:22 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 18:38:22 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/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 18:38:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/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 18:38:22 INFO - Downloaded 59514634 bytes. 18:38:22 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 18:38:22 INFO - mkdir: /builds/slave/test/properties 18:38:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:38:22 INFO - Writing to file /builds/slave/test/properties/build_url 18:38:22 INFO - Contents: 18:38:22 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 18:38:23 INFO - Running post-action listener: _resource_record_post_action 18:38:23 INFO - Running post-action listener: set_extra_try_arguments 18:38:23 INFO - [mozharness: 2016-10-18 01:38:23.018099Z] Finished download-and-extract step (success) 18:38:23 INFO - [mozharness: 2016-10-18 01:38:23.018327Z] Running populate-webroot step. 18:38:23 INFO - Running pre-action listener: _resource_record_pre_action 18:38:23 INFO - Running main action method: populate_webroot 18:38:23 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:38:23 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:38:23 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:38:23 INFO - '--tppagecycles', 18:38:23 INFO - '7'], 18:38:23 INFO - 'tests': ['tsvgm']}}, 18:38:23 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:38:23 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 18:38:23 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['dromaeo_css', 'kraken']}, 18:38:23 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 18:38:23 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:38:23 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:38:23 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['damp', 'tps']}, 18:38:23 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'tests': ['damp', 'tps']}, 18:38:23 INFO - 'g3': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['dromaeo_dom']}, 18:38:23 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:38:23 INFO - 'g4': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['basic_compositor_video']}, 18:38:23 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 18:38:23 INFO - 'other': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['a11yr', 18:38:23 INFO - 'ts_paint', 18:38:23 INFO - 'tpaint', 18:38:23 INFO - 'sessionrestore', 18:38:23 INFO - 'sessionrestore_no_auto_restore', 18:38:23 INFO - 'tabpaint']}, 18:38:23 INFO - 'other-e10s': {'tests': ['a11yr', 18:38:23 INFO - 'ts_paint', 18:38:23 INFO - 'tpaint', 18:38:23 INFO - 'sessionrestore', 18:38:23 INFO - 'sessionrestore_no_auto_restore', 18:38:23 INFO - 'tabpaint']}, 18:38:23 INFO - 'other-e10s_l64': {'tests': ['a11yr', 18:38:23 INFO - 'ts_paint', 18:38:23 INFO - 'tpaint', 18:38:23 INFO - 'sessionrestore', 18:38:23 INFO - 'sessionrestore_no_auto_restore', 18:38:23 INFO - 'tabpaint']}, 18:38:23 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 18:38:23 INFO - 'ts_paint', 18:38:23 INFO - 'tpaint', 18:38:23 INFO - 'sessionrestore', 18:38:23 INFO - 'sessionrestore_no_auto_restore', 18:38:23 INFO - 'tabpaint']}, 18:38:23 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['a11yr', 18:38:23 INFO - 'ts_paint', 18:38:23 INFO - 'tpaint', 18:38:23 INFO - 'sessionrestore', 18:38:23 INFO - 'sessionrestore_no_auto_restore', 18:38:23 INFO - 'tabpaint']}, 18:38:23 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['a11yr', 18:38:23 INFO - 'ts_paint', 18:38:23 INFO - 'tpaint', 18:38:23 INFO - 'sessionrestore', 18:38:23 INFO - 'sessionrestore_no_auto_restore', 18:38:23 INFO - 'tabpaint']}, 18:38:23 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['tsvgx', 18:38:23 INFO - 'tsvgr_opacity', 18:38:23 INFO - 'tart', 18:38:23 INFO - 'tscrollx', 18:38:23 INFO - 'cart']}, 18:38:23 INFO - 'svgr-e10s': {'tests': ['tsvgx', 18:38:23 INFO - 'tsvgr_opacity', 18:38:23 INFO - 'tart', 18:38:23 INFO - 'tscrollx', 18:38:23 INFO - 'cart']}, 18:38:23 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'talos_options': ['--disable-e10s'], 18:38:23 INFO - 'tests': ['tp5o']}, 18:38:23 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'tests': ['tp5o']}, 18:38:23 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'talos_options': ['--disable-e10s', 18:38:23 INFO - '--xperf_path', 18:38:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:38:23 INFO - 'tests': ['tp5n']}, 18:38:23 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:23 INFO - 'talos_options': ['--xperf_path', 18:38:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:38:23 INFO - 'tests': ['tp5n']}}, 18:38:23 INFO - 'talos.zip': {'path': '', 18:38:23 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:38:23 INFO - Running post-action listener: _resource_record_post_action 18:38:23 INFO - [mozharness: 2016-10-18 01:38:23.038535Z] Finished populate-webroot step (success) 18:38:23 INFO - [mozharness: 2016-10-18 01:38:23.038624Z] Running create-virtualenv step. 18:38:23 INFO - Running pre-action listener: _resource_record_pre_action 18:38:23 INFO - Running main action method: create_virtualenv 18:38:23 INFO - Creating virtualenv /builds/slave/test/build/venv 18:38:23 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 18:38:23 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:38:23 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:38:23 INFO - Using real prefix '/usr' 18:38:23 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:38:23 INFO - Installing distribute.............................................................................................................................................................................................done. 18:38:25 INFO - Installing pip.................done. 18:38:25 INFO - Return code: 0 18:38:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 18:38:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 18:38:25 INFO - Reading from file tmpfile_stdout 18:38:25 INFO - Output received: 18:38:25 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) 18:38:25 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:38: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')]} 18:38:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38: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')]} 18:38:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 18:38:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 18:38:25 INFO - Using env: {'DISPLAY': ':0', 18:38:25 INFO - 'HOME': '/home/cltbld', 18:38:25 INFO - 'LANG': 'en_US.UTF-8', 18:38:25 INFO - 'LANGUAGE': 'en_US:en', 18:38:25 INFO - 'LOGNAME': 'cltbld', 18:38:25 INFO - 'MAIL': '/var/mail/cltbld', 18:38:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:25 INFO - 'MOZ_NO_REMOTE': '1', 18:38:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:25 INFO - 'NO_EM_RESTART': '1', 18:38:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:25 INFO - 'PWD': '/builds/slave/test', 18:38:25 INFO - 'SHELL': '/bin/bash', 18:38:25 INFO - 'SHLVL': '1', 18:38:25 INFO - 'TERM': 'linux', 18:38:25 INFO - 'TMOUT': '86400', 18:38:25 INFO - 'USER': 'cltbld', 18:38:25 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:25 INFO - '_': '/tools/buildbot/bin/python'} 18:38:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:26 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 18:38:26 INFO - Cleaning up... 18:38:26 INFO - Return code: 0 18:38:26 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 18:38:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 18:38:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 18:38:26 INFO - Using env: {'DISPLAY': ':0', 18:38:26 INFO - 'HOME': '/home/cltbld', 18:38:26 INFO - 'LANG': 'en_US.UTF-8', 18:38:26 INFO - 'LANGUAGE': 'en_US:en', 18:38:26 INFO - 'LOGNAME': 'cltbld', 18:38:26 INFO - 'MAIL': '/var/mail/cltbld', 18:38:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:26 INFO - 'MOZ_NO_REMOTE': '1', 18:38:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:26 INFO - 'NO_EM_RESTART': '1', 18:38:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:26 INFO - 'PWD': '/builds/slave/test', 18:38:26 INFO - 'SHELL': '/bin/bash', 18:38:26 INFO - 'SHLVL': '1', 18:38:26 INFO - 'TERM': 'linux', 18:38:26 INFO - 'TMOUT': '86400', 18:38:26 INFO - 'USER': 'cltbld', 18:38:26 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:26 INFO - '_': '/tools/buildbot/bin/python'} 18:38:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:26 INFO - Downloading/unpacking psutil>=3.1.1 18:38:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:38:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:38:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:38:28 INFO - Installing collected packages: psutil 18:38:28 INFO - Running setup.py install for psutil 18:38:28 INFO - building 'psutil._psutil_linux' extension 18:38:28 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 18:38:28 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 18:38:28 INFO - building 'psutil._psutil_posix' extension 18:38:28 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 18:38:28 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 18:38:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:38:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:38:28 INFO - Successfully installed psutil 18:38:28 INFO - Cleaning up... 18:38:28 INFO - Return code: 0 18:38:28 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 18:38:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 18:38:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 18:38:28 INFO - Using env: {'DISPLAY': ':0', 18:38:28 INFO - 'HOME': '/home/cltbld', 18:38:28 INFO - 'LANG': 'en_US.UTF-8', 18:38:28 INFO - 'LANGUAGE': 'en_US:en', 18:38:28 INFO - 'LOGNAME': 'cltbld', 18:38:28 INFO - 'MAIL': '/var/mail/cltbld', 18:38:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:28 INFO - 'MOZ_NO_REMOTE': '1', 18:38:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:28 INFO - 'NO_EM_RESTART': '1', 18:38:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:28 INFO - 'PWD': '/builds/slave/test', 18:38:28 INFO - 'SHELL': '/bin/bash', 18:38:28 INFO - 'SHLVL': '1', 18:38:28 INFO - 'TERM': 'linux', 18:38:28 INFO - 'TMOUT': '86400', 18:38:28 INFO - 'USER': 'cltbld', 18:38:28 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:28 INFO - '_': '/tools/buildbot/bin/python'} 18:38:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:29 INFO - Downloading/unpacking mozsystemmonitor==0.3 18:38:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:29 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:29 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:30 INFO - Downloading mozsystemmonitor-0.3.tar.gz 18:38:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:38:31 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 18:38:31 INFO - Installing collected packages: mozsystemmonitor 18:38:31 INFO - Running setup.py install for mozsystemmonitor 18:38:31 INFO - Successfully installed mozsystemmonitor 18:38:31 INFO - Cleaning up... 18:38:31 INFO - Return code: 0 18:38:31 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 18:38:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 18:38:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 18:38:31 INFO - Using env: {'DISPLAY': ':0', 18:38:31 INFO - 'HOME': '/home/cltbld', 18:38:31 INFO - 'LANG': 'en_US.UTF-8', 18:38:31 INFO - 'LANGUAGE': 'en_US:en', 18:38:31 INFO - 'LOGNAME': 'cltbld', 18:38:31 INFO - 'MAIL': '/var/mail/cltbld', 18:38:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:31 INFO - 'MOZ_NO_REMOTE': '1', 18:38:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:31 INFO - 'NO_EM_RESTART': '1', 18:38:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:31 INFO - 'PWD': '/builds/slave/test', 18:38:31 INFO - 'SHELL': '/bin/bash', 18:38:31 INFO - 'SHLVL': '1', 18:38:31 INFO - 'TERM': 'linux', 18:38:31 INFO - 'TMOUT': '86400', 18:38:31 INFO - 'USER': 'cltbld', 18:38:31 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:31 INFO - '_': '/tools/buildbot/bin/python'} 18:38:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:31 INFO - Downloading/unpacking jsonschema==2.5.1 18:38:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:33 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:38:33 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 18:38:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:33 INFO - Downloading functools32-3.2.3-2.tar.gz 18:38:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:38:33 INFO - warning: no files found matching '*.txt' 18:38:33 INFO - no previously-included directories found matching 'build' 18:38:33 INFO - no previously-included directories found matching 'dist' 18:38:33 INFO - no previously-included directories found matching '.git*' 18:38:33 INFO - Installing collected packages: jsonschema, functools32 18:38:33 INFO - Running setup.py install for functools32 18:38:33 INFO - warning: no files found matching '*.txt' 18:38:33 INFO - no previously-included directories found matching 'build' 18:38:33 INFO - no previously-included directories found matching 'dist' 18:38:33 INFO - no previously-included directories found matching '.git*' 18:38:33 INFO - Successfully installed jsonschema functools32 18:38:33 INFO - Cleaning up... 18:38:33 INFO - Return code: 0 18:38:33 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 18:38:33 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')]} 18:38:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:33 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')]} 18:38:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:33 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 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:33 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 18:38:33 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 18:38:33 INFO - Using env: {'DISPLAY': ':0', 18:38:33 INFO - 'HOME': '/home/cltbld', 18:38:33 INFO - 'LANG': 'en_US.UTF-8', 18:38:33 INFO - 'LANGUAGE': 'en_US:en', 18:38:33 INFO - 'LOGNAME': 'cltbld', 18:38:33 INFO - 'MAIL': '/var/mail/cltbld', 18:38:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:33 INFO - 'MOZ_NO_REMOTE': '1', 18:38:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:33 INFO - 'NO_EM_RESTART': '1', 18:38:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:33 INFO - 'PWD': '/builds/slave/test', 18:38:33 INFO - 'SHELL': '/bin/bash', 18:38:33 INFO - 'SHLVL': '1', 18:38:33 INFO - 'TERM': 'linux', 18:38:33 INFO - 'TMOUT': '86400', 18:38:33 INFO - 'USER': 'cltbld', 18:38:33 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:33 INFO - '_': '/tools/buildbot/bin/python'} 18:38:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:34 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 18:38:34 INFO - Cleaning up... 18:38:34 INFO - Return code: 0 18:38:34 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:38:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:34 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 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:34 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 18:38:34 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 18:38:34 INFO - Using env: {'DISPLAY': ':0', 18:38:34 INFO - 'HOME': '/home/cltbld', 18:38:34 INFO - 'LANG': 'en_US.UTF-8', 18:38:34 INFO - 'LANGUAGE': 'en_US:en', 18:38:34 INFO - 'LOGNAME': 'cltbld', 18:38:34 INFO - 'MAIL': '/var/mail/cltbld', 18:38:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:34 INFO - 'MOZ_NO_REMOTE': '1', 18:38:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:34 INFO - 'NO_EM_RESTART': '1', 18:38:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:34 INFO - 'PWD': '/builds/slave/test', 18:38:34 INFO - 'SHELL': '/bin/bash', 18:38:34 INFO - 'SHLVL': '1', 18:38:34 INFO - 'TERM': 'linux', 18:38:34 INFO - 'TMOUT': '86400', 18:38:34 INFO - 'USER': 'cltbld', 18:38:34 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:34 INFO - '_': '/tools/buildbot/bin/python'} 18:38:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:34 INFO - Downloading/unpacking blobuploader==1.2.4 18:38:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:36 INFO - Downloading blobuploader-1.2.4.tar.gz 18:38:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:38:36 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:38:36 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 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 18:38:36 INFO - Downloading docopt-0.6.1.tar.gz 18:38:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:38:36 INFO - Installing collected packages: blobuploader, requests, docopt 18:38:36 INFO - Running setup.py install for blobuploader 18:38:37 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:38:37 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:38:37 INFO - Running setup.py install for requests 18:38:37 INFO - Running setup.py install for docopt 18:38:37 INFO - Successfully installed blobuploader requests docopt 18:38:37 INFO - Cleaning up... 18:38:37 INFO - Return code: 0 18:38:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:38: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')]} 18:38:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38: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')]} 18:38:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:37 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 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:37 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 18:38:37 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 18:38:37 INFO - Using env: {'DISPLAY': ':0', 18:38:37 INFO - 'HOME': '/home/cltbld', 18:38:37 INFO - 'LANG': 'en_US.UTF-8', 18:38:37 INFO - 'LANGUAGE': 'en_US:en', 18:38:37 INFO - 'LOGNAME': 'cltbld', 18:38:37 INFO - 'MAIL': '/var/mail/cltbld', 18:38:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:37 INFO - 'MOZ_NO_REMOTE': '1', 18:38:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:37 INFO - 'NO_EM_RESTART': '1', 18:38:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:37 INFO - 'PWD': '/builds/slave/test', 18:38:37 INFO - 'SHELL': '/bin/bash', 18:38:37 INFO - 'SHLVL': '1', 18:38:37 INFO - 'TERM': 'linux', 18:38:37 INFO - 'TMOUT': '86400', 18:38:37 INFO - 'USER': 'cltbld', 18:38:37 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:37 INFO - '_': '/tools/buildbot/bin/python'} 18:38:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:38:37 INFO - Running setup.py (path:/tmp/pip-NTUtle-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:38:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:38:37 INFO - Running setup.py (path:/tmp/pip-BhZxTK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:38:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:38:37 INFO - Running setup.py (path:/tmp/pip-ZbrJjy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:38:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:38:37 INFO - Running setup.py (path:/tmp/pip-C5FTj1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:38:38 INFO - Running setup.py (path:/tmp/pip-uz7tw6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:38:38 INFO - Running setup.py (path:/tmp/pip-kQ_7K8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:38:38 INFO - Running setup.py (path:/tmp/pip-MYQcWo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:38:38 INFO - Running setup.py (path:/tmp/pip-K2_BsS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:38:38 INFO - Running setup.py (path:/tmp/pip-ugVgaW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:38:38 INFO - Running setup.py (path:/tmp/pip-pDXXKQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:38:38 INFO - Running setup.py (path:/tmp/pip-0BU2u4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:38:38 INFO - Running setup.py (path:/tmp/pip-wP0HHv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:38:38 INFO - Running setup.py (path:/tmp/pip-p_zsMg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:38:38 INFO - Running setup.py (path:/tmp/pip-qhRbeI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:38 INFO - Running setup.py (path:/tmp/pip-9fVMCm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:38:38 INFO - Running setup.py (path:/tmp/pip-wlhUIX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:38:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:38:38 INFO - Running setup.py (path:/tmp/pip-cUcKfs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:38:38 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:38:38 INFO - Running setup.py install for manifestparser 18:38:39 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Running setup.py install for mozcrash 18:38:39 INFO - Running setup.py install for mozdebug 18:38:39 INFO - Running setup.py install for mozdevice 18:38:39 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Running setup.py install for mozfile 18:38:39 INFO - Running setup.py install for mozhttpd 18:38:39 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Running setup.py install for mozinfo 18:38:39 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Running setup.py install for mozInstall 18:38:39 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:38:39 INFO - Running setup.py install for mozleak 18:38:39 INFO - Running setup.py install for mozlog 18:38:40 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:38:40 INFO - Running setup.py install for moznetwork 18:38:40 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:38:40 INFO - Running setup.py install for mozprocess 18:38:40 INFO - Running setup.py install for mozprofile 18:38:40 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:38:40 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:38:40 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:38:40 INFO - Running setup.py install for mozrunner 18:38:40 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:38:40 INFO - Running setup.py install for mozscreenshot 18:38:40 INFO - Running setup.py install for moztest 18:38:40 INFO - Running setup.py install for mozversion 18:38:40 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:38:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:38:40 INFO - Cleaning up... 18:38:40 INFO - Return code: 0 18:38:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:38:40 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')]} 18:38:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:40 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')]} 18:38:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:40 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 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:40 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 18:38:40 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 18:38:40 INFO - Using env: {'DISPLAY': ':0', 18:38:40 INFO - 'HOME': '/home/cltbld', 18:38:40 INFO - 'LANG': 'en_US.UTF-8', 18:38:40 INFO - 'LANGUAGE': 'en_US:en', 18:38:40 INFO - 'LOGNAME': 'cltbld', 18:38:40 INFO - 'MAIL': '/var/mail/cltbld', 18:38:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:40 INFO - 'MOZ_NO_REMOTE': '1', 18:38:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:40 INFO - 'NO_EM_RESTART': '1', 18:38:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:40 INFO - 'PWD': '/builds/slave/test', 18:38:40 INFO - 'SHELL': '/bin/bash', 18:38:40 INFO - 'SHLVL': '1', 18:38:40 INFO - 'TERM': 'linux', 18:38:40 INFO - 'TMOUT': '86400', 18:38:40 INFO - 'USER': 'cltbld', 18:38:40 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:40 INFO - '_': '/tools/buildbot/bin/python'} 18:38:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:38:41 INFO - Running setup.py (path:/tmp/pip-HE63cE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:38:41 INFO - Running setup.py (path:/tmp/pip-WbPTHR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:38:41 INFO - Running setup.py (path:/tmp/pip-7dqQ1V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:38:41 INFO - Running setup.py (path:/tmp/pip-_cys3T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:38:41 INFO - Running setup.py (path:/tmp/pip-1Z5bxg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:38:41 INFO - Running setup.py (path:/tmp/pip-MnQiHz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:38:41 INFO - Running setup.py (path:/tmp/pip-wPdw42-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:38:41 INFO - Running setup.py (path:/tmp/pip-tjuvpy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:38:41 INFO - Running setup.py (path:/tmp/pip-qLlRGb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:38:41 INFO - Running setup.py (path:/tmp/pip-DmrgwP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:38:41 INFO - Running setup.py (path:/tmp/pip-79Rsci-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:38:41 INFO - Running setup.py (path:/tmp/pip-YN7Wxf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:38:41 INFO - Running setup.py (path:/tmp/pip-mgFuwN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:38:41 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)) 18:38:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:38:41 INFO - Running setup.py (path:/tmp/pip-RJrJMy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:38:42 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)) 18:38:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:42 INFO - Running setup.py (path:/tmp/pip-HRbg5p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:42 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)) 18:38:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:38:42 INFO - Running setup.py (path:/tmp/pip-_IrMlu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:38:42 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)) 18:38:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:38:42 INFO - Running setup.py (path:/tmp/pip-zMn3mh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:38:42 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)) 18:38:42 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)) 18:38:42 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)) 18:38:42 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)) 18:38:42 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)) 18:38:42 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)) 18:38:42 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:38:42 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 18:38:42 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 18:38:42 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 18:38:42 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 18:38:42 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 18:38:42 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 18:38:44 INFO - Downloading blessings-1.6.tar.gz 18:38:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:38:44 INFO - Installing collected packages: blessings 18:38:44 INFO - Running setup.py install for blessings 18:38:44 INFO - Successfully installed blessings 18:38:44 INFO - Cleaning up... 18:38:44 INFO - Return code: 0 18:38:44 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:38:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:38:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:38:44 INFO - Reading from file tmpfile_stdout 18:38:44 INFO - Current package versions: 18:38:44 INFO - argparse == 1.2.1 18:38:44 INFO - blessings == 1.6 18:38:44 INFO - blobuploader == 1.2.4 18:38:44 INFO - docopt == 0.6.1 18:38:44 INFO - functools32 == 3.2.3-2 18:38:44 INFO - jsonschema == 2.5.1 18:38:44 INFO - manifestparser == 1.1 18:38:44 INFO - mozInstall == 1.12 18:38:44 INFO - mozcrash == 0.17 18:38:44 INFO - mozdebug == 0.1 18:38:44 INFO - mozdevice == 0.48 18:38:44 INFO - mozfile == 1.2 18:38:44 INFO - mozhttpd == 0.7 18:38:44 INFO - mozinfo == 0.9 18:38:44 INFO - mozleak == 0.1 18:38:44 INFO - mozlog == 3.4 18:38:44 INFO - moznetwork == 0.27 18:38:44 INFO - mozprocess == 0.23 18:38:44 INFO - mozprofile == 0.28 18:38:44 INFO - mozrunner == 6.12 18:38:44 INFO - mozscreenshot == 0.1 18:38:44 INFO - mozsystemmonitor == 0.3 18:38:44 INFO - moztest == 0.7 18:38:44 INFO - mozversion == 1.4 18:38:44 INFO - psutil == 3.1.1 18:38:44 INFO - requests == 1.2.3 18:38:44 INFO - wsgiref == 0.1.2 18:38:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:38:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:44 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 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:44 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 18:38:44 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 18:38:44 INFO - Using env: {'DISPLAY': ':0', 18:38:44 INFO - 'HOME': '/home/cltbld', 18:38:44 INFO - 'LANG': 'en_US.UTF-8', 18:38:44 INFO - 'LANGUAGE': 'en_US:en', 18:38:44 INFO - 'LOGNAME': 'cltbld', 18:38:44 INFO - 'MAIL': '/var/mail/cltbld', 18:38:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:44 INFO - 'MOZ_NO_REMOTE': '1', 18:38:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:44 INFO - 'NO_EM_RESTART': '1', 18:38:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:44 INFO - 'PWD': '/builds/slave/test', 18:38:44 INFO - 'SHELL': '/bin/bash', 18:38:44 INFO - 'SHLVL': '1', 18:38:44 INFO - 'TERM': 'linux', 18:38:44 INFO - 'TMOUT': '86400', 18:38:44 INFO - 'USER': 'cltbld', 18:38:44 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:44 INFO - '_': '/tools/buildbot/bin/python'} 18:38:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 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)) 18:38:44 INFO - Cleaning up... 18:38:44 INFO - Return code: 0 18:38:44 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:38:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:38:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f6ca3eeef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28818a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294d7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, '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': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', '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 18:38:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 18:38:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 18:38:44 INFO - Using env: {'DISPLAY': ':0', 18:38:44 INFO - 'HOME': '/home/cltbld', 18:38:44 INFO - 'LANG': 'en_US.UTF-8', 18:38:44 INFO - 'LANGUAGE': 'en_US:en', 18:38:44 INFO - 'LOGNAME': 'cltbld', 18:38:44 INFO - 'MAIL': '/var/mail/cltbld', 18:38:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:44 INFO - 'MOZ_NO_REMOTE': '1', 18:38:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:44 INFO - 'NO_EM_RESTART': '1', 18:38:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:44 INFO - 'PWD': '/builds/slave/test', 18:38:44 INFO - 'SHELL': '/bin/bash', 18:38:44 INFO - 'SHLVL': '1', 18:38:44 INFO - 'TERM': 'linux', 18:38:44 INFO - 'TMOUT': '86400', 18:38:44 INFO - 'USER': 'cltbld', 18:38:44 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:38:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:44 INFO - '_': '/tools/buildbot/bin/python'} 18:38:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:45 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 18:38:45 INFO - Cleaning up... 18:38:45 INFO - Return code: 0 18:38:45 INFO - Running post-action listener: _resource_record_post_action 18:38:45 INFO - Running post-action listener: _start_resource_monitoring 18:38:45 INFO - Starting resource monitoring. 18:38:45 INFO - [mozharness: 2016-10-18 01:38:45.137555Z] Finished create-virtualenv step (success) 18:38:45 INFO - [mozharness: 2016-10-18 01:38:45.138065Z] Running install step. 18:38:45 INFO - Running pre-action listener: _resource_record_pre_action 18:38:45 INFO - Running main action method: install 18:38:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:38:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:38:45 INFO - Reading from file tmpfile_stdout 18:38:45 INFO - Detecting whether we're running mozinstall >=1.0... 18:38:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:38:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:38:45 INFO - Reading from file tmpfile_stdout 18:38:45 INFO - Output received: 18:38:45 INFO - Usage: mozinstall [options] installer 18:38:45 INFO - Options: 18:38:45 INFO - -h, --help show this help message and exit 18:38:45 INFO - -d DEST, --destination=DEST 18:38:45 INFO - Directory to install application into. [default: 18:38:45 INFO - "/builds/slave/test"] 18:38:45 INFO - --app=APP Application being installed. [default: firefox] 18:38:45 INFO - mkdir: /builds/slave/test/build/application 18:38:45 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'] 18:38:45 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 18:39:02 INFO - Reading from file tmpfile_stdout 18:39:02 INFO - Output received: 18:39:02 INFO - /builds/slave/test/build/application/firefox/firefox 18:39:02 INFO - Running post-action listener: _resource_record_post_action 18:39:02 INFO - [mozharness: 2016-10-18 01:39:02.378009Z] Finished install step (success) 18:39:02 INFO - [mozharness: 2016-10-18 01:39:02.378282Z] Running run-tests step. 18:39:02 INFO - Running pre-action listener: _resource_record_pre_action 18:39:02 INFO - Running main action method: run_tests 18:39:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:39:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:39:02 INFO - Python 2.7.3 18:39:02 INFO - Return code: 0 18:39:02 INFO - grabbing minidump binary from tooltool 18:39:02 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')]} 18:39:02 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 0x29dc790>, '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 0x29dd690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29ddb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:39:02 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 18:39:02 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 18:39:02 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 18:39:02 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:39:02 INFO - Return code: 0 18:39:02 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:39:02 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:39:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:39:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:39:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:39:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-017', '--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 18:39:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-017 --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 18:39:02 INFO - Using env: {'DISPLAY': ':0', 18:39:02 INFO - 'HOME': '/home/cltbld', 18:39:02 INFO - 'LANG': 'en_US.UTF-8', 18:39:02 INFO - 'LANGUAGE': 'en_US:en', 18:39:02 INFO - 'LOGNAME': 'cltbld', 18:39:02 INFO - 'MAIL': '/var/mail/cltbld', 18:39:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:39:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:39:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:39:02 INFO - 'MOZ_NO_REMOTE': '1', 18:39:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:39:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:39:02 INFO - 'NO_EM_RESTART': '1', 18:39:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:39:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:39:02 INFO - 'PWD': '/builds/slave/test', 18:39:02 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:39:02 INFO - 'SHELL': '/bin/bash', 18:39:02 INFO - 'SHLVL': '1', 18:39:02 INFO - 'TERM': 'linux', 18:39:02 INFO - 'TMOUT': '86400', 18:39:02 INFO - 'USER': 'cltbld', 18:39:02 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934', 18:39:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:39:02 INFO - '_': '/tools/buildbot/bin/python'} 18:39:02 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-017', '--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 18:39:02 INFO - mozversion application_buildid: 20161017123005 18:39:02 INFO - mozversion application_changeset: d088dafca4fd2c8e4d586f2ffe5947cb09978c00 18:39:02 INFO - mozversion application_display_name: Nightly 18:39:02 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:39:02 INFO - mozversion application_name: Firefox 18:39:02 INFO - mozversion application_remotingname: firefox 18:39:02 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 18:39:02 INFO - mozversion application_vendor: Mozilla 18:39:02 INFO - mozversion application_version: 52.0a1 18:39:02 INFO - mozversion platform_buildid: 20161017123005 18:39:02 INFO - mozversion platform_changeset: d088dafca4fd2c8e4d586f2ffe5947cb09978c00 18:39:02 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 18:39:02 INFO - mozversion platform_version: 52.0a1 18:39:02 INFO - using testdate: 1476754742 18:39:02 INFO - actual date: 1476754742 18:39:02 INFO - starting webserver on 'localhost:33975' 18:39:02 INFO - SUITE-START | Running 2 tests 18:39:02 INFO - TEST-START | dromaeo_css 18:39:02 INFO - operating with platform_type : linux_ 18:39:02 INFO - Initialising browser for dromaeo_css test... 18:39:02 INFO - TEST-INFO | started process 27181 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKbkl8n/profile http://localhost:33975/getInfo.html) 18:39:06 INFO - PROCESS | 27181 | __metrics Screen width/height:1600/1200 18:39:06 INFO - PROCESS | 27181 | colorDepth:24 18:39:06 INFO - PROCESS | 27181 | Browser inner width/height: 1024/697 18:39:06 INFO - PROCESS | 27181 | __metrics 18:39:06 INFO - PROCESS | 27181 | 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" 18:39:06 INFO - PROCESS | 27181 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:39:07 INFO - PROCESS | 27181 | console.error: PushService: 18:39:07 INFO - PROCESS | 27181 | stateChangeProcessEnqueue: Error transitioning state 18:39:07 INFO - PROCESS | 27181 | UnknownError 18:39:08 INFO - TEST-INFO | 27181: exit 0 18:39:08 INFO - Browser initialized. 18:39:08 INFO - Running cycle 1/1 for dromaeo_css test... 18:39:08 INFO - TEST-INFO | started process 27266 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKbkl8n/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:39:20 INFO - PROCESS | 27266 | RSS: Main: 172298240 18:39:20 INFO - PROCESS | 27266 | 18:40:11 INFO - PROCESS | 27266 | 1476754811921 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] 18:42:22 INFO - PROCESS | 27266 | Cycle 1(1): loaded http://localhost:33975/tests/dromaeo/cssquery-dojo.html (next: http://localhost:33975/tests/dromaeo/cssquery-ext.html) 18:42:23 INFO - PROCESS | 27266 | RSS: Main: 317222912 18:42:23 INFO - PROCESS | 27266 | 18:45:26 INFO - PROCESS | 27266 | Cycle 1(1): loaded http://localhost:33975/tests/dromaeo/cssquery-ext.html (next: http://localhost:33975/tests/dromaeo/cssquery-jquery.html) 18:45:27 INFO - PROCESS | 27266 | RSS: Main: 276676608 18:45:27 INFO - PROCESS | 27266 | 18:48:29 INFO - PROCESS | 27266 | Cycle 1(1): loaded http://localhost:33975/tests/dromaeo/cssquery-jquery.html (next: http://localhost:33975/tests/dromaeo/cssquery-mootools.html) 18:48:29 INFO - PROCESS | 27266 | RSS: Main: 246501376 18:48:29 INFO - PROCESS | 27266 | 18:51:31 INFO - PROCESS | 27266 | Cycle 1(1): loaded http://localhost:33975/tests/dromaeo/cssquery-mootools.html (next: http://localhost:33975/tests/dromaeo/cssquery-prototype.html) 18:51:32 INFO - PROCESS | 27266 | RSS: Main: 241565696 18:51:32 INFO - PROCESS | 27266 | 18:54:35 INFO - PROCESS | 27266 | Cycle 1(1): loaded http://localhost:33975/tests/dromaeo/cssquery-prototype.html (next: http://localhost:33975/tests/dromaeo/cssquery-yui.html) 18:54:35 INFO - PROCESS | 27266 | RSS: Main: 216006656 18:54:35 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | Cycle 1(1): loaded http://localhost:33975/tests/dromaeo/cssquery-yui.html (next: http://localhost:33975/tests/dromaeo/cssquery-dojo.html) 18:57:38 INFO - PROCESS | 27266 | RSS: Main: 305381376 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | __start_tp_report 18:57:38 INFO - PROCESS | 27266 | _x_x_mozilla_page_load 18:57:38 INFO - PROCESS | 27266 | _x_x_mozilla_page_load_details 18:57:38 INFO - PROCESS | 27266 | |i|pagename|runs| 18:57:38 INFO - PROCESS | 27266 | |0;dojo.html;3000.789944703871;3004.654464736553;3045.6192975878016;3047.9390412191756;3050.6339239291274;5083.949160508394;5192.195209742486;5193.662411943221;5207.869803254921;5340.412554618989;5213.191955246943;5215.739213039352;5363.329583802025;5378.838634840951;5411.729413529318;4838.879028024292;4861.975690121544;4911;4933.605311575084;4945.35710357653;4884.3406140171155;4951.801927922878;5026.522480364378;5030.899382012358;5064.290999260106;4687.062587482517;4730.739809310487;4889.022195560902;4931.112399768041;4961.305417241589;4784.067106914154;4795.160846851822;4843.443004054544;4863.756812159378;4911.18965370717;4789.2816077588295;4823.5176482351835;4827.710337379734;4834.830780922651;4884.462709101996;5293;5297.708626025567;5299.152135658314;5300.363956325227;5311.707856067915;5432.049391356497;5502.80740174092;5508.14623733322;5588.608797384185;5705.115707065412;5620.494155526022;5627.043402621564;5636.4927156556105;5636.689982050985;5645.350784659776;5199.948000519984;5250.7374631268285;5260.105782017066;5266.0257852297445;5354.759035843396;5870.295564532284;5889.352171261158;5939.3466718661775;5998.220231369894;5999.340072592011;5699.202111704365;5703.201551782754;5703.971480142573;5705.5435565154685;5712.086066229466;5431.972840135853;5490.862728431821;5770.624909380961;5770.971145144247;5773.538116950634;5388.434214407509;5621.409751976065;5674.12051132067;5691.544676425959;5755;5696.601237913306;5703.40114288002;5704.80033198836;5706.058500347396;5774.2782152230975;4250.426192463978;4421.712588681726;4426.513083560806;4431.379606855043;4484.2376795944765;3846.9230615387537;3888.8444462221196;3919.4904662393706;3944.053427177457;3950.9802450987563;5473.31583552056;5474.39781624021;5476.726163691799;5486.3690675572025;5539;5810.82567522975;5813.09896965971;5818.941810581925;5823.592348535646;5824.475797178275;5167.147420675622;5189.584833213334;5192.584593232532;5292.576593872481;5458.754356053987;4827.637927155477;4895.510448955076;4895.951040489549;4932.408111026628;5011.4236862761245;5836.708164591669;5842.094475356326;5894.2926848778425;5896.086106653475;5941.851453713692;5713.485786279089;5714.971425142848;5717.7141142941855;5719.57103217252;5721.742521586455;5519.834404967857;5650.152477128464;5736.971315143398;5802.622829516068;5862.560307977004;5526.889462210653;5543;5546.168074788814;5599;5602.215689803512;5642.802501912413;5644.153376993484;5651.321841379061;5658;5659.179418984142;5308.46915308466;5364.946350536445;5445.128779395436;5492.038893193755;5538.944610553843;5388.137897936312;5503.504684578407;5532.91700624499;5569.10894256917;5595.860103497445;5489.3687225969525;5499.257600223918;5505.311836020497;5506.311711036121;5508.14623733322;5285.5243028126115;5329.094054010905;5562.360328562268;5591.608587398843;5646.3506696728755;5376.59675524345;5419.674819510842;5422.8373148805595;5450.482204190595;5509.889802204014 18:57:38 INFO - PROCESS | 27266 | |1;ext.html;542.7081693323578;580.2340909998801;598.6767145741298;610.179308829624;615.4553220399945;31106.222344441372;41835.79082104589;42733.29066837323;42767.35848962268;42853.57146428535;43058.56941430585;43493.13013739731;43495.78252108743;43513;43533;8149.674013039471;8615.56922153893;8820.294376449869;8888.555572221396;8919.375643704943;7940.2853743163105;10446.216533759998;10697.251192416534;10698.251122421434;10966.013058824705;10838.945805271002;10879;10910.23628346016;10919.890801092006;10926.180536459757;10542.683719488428;10608.15134789215;10611.575536978511;10613;10627.52176152075;10539.104176145036;10552.103071238955;10600.734981625445;10600.94699526505;10614.522346494427;40184.39723404151;40526.18947621031;40587.18825623471;40675.1864962702;41001.794991025155;3137.074563003919;3154.6529881713222;3476.721862251014;3504.3166582516164;4050.4734384529825;30358.383699015532;30807.845960770275;30842.691573084205;31330.843345783353;31733.365332693218;3891.805409729502;3938.074552480165;3982.8805135845682;4104.117614712851;4127.40152677863;324839;325826;328873;329543;330500;32727.50908736371;55118.72440637771;55392.522009529006;55403.72298138483;55449;34230.48654270188;36409.63590364062;36423.27153456916;36434.45348319777;36441.27117457636;13169.802452963213;13199.736005279841;13254.271015094262;13286.66783330405;13292.933535332262;9271.16559509634;9414.964353921063;10456;10796.460176991119;10922.890771092187;8038.517688938682;8093.514389136671;8134.796630084295;8219.671213151527;8233;2980.7629833618807;3050.542418637222;3105.1460848266456;3180.189051791778;3240.4329242382487;982.4350998176077;1002.5688953749811;1008.178334657252;1036.896310368957;1065.3980501016902;30979.845100774353;30989.535156972663;31521.37504187002;31556.526652100238;32062.67937320597;1027.6660085472251;1076.4671487613682;1078.4230436716475;1107.595727559435;1121.899029087386;15900.681986360209;16699.248533816008;16745.162741863103;16782.916085419496;16829.915850420668;469949;474898;475318;475692;476203;55039;55269.723651381486;55285.170722439194;55294.51174697148;55320.446795532334;1177.9823302650468;1188.607759439383;1191.2852288626755;1215.1190386969377;1216.647172320035;30743.846280768452;33875;33959.4906076414;34107.82946085254;34636.96089117331;51692.48307517027;52246.47753522416;53887.73056134694;54055.72972135114;59123;481692;484464;484729;485192;490773;26095.60856587115;27382.5892611607;41556;41814.58185418229;42311.7884410576;44347.77826110849;45501.77249113733;45514.31728524008;45596.54403455923;45881.54118458906;38160.07837962094;38441.231175376895;38442.615573843905;38867.416988745754;40133.1973360537;38675;38949.415758763076;39250;39961.80019099886;40486.59513404828;38329.80835095807;38879.41680874732;39032.609673902894;39206.607933921434;39315.410268846565;31815.68184318127;34519.4822077664;34568.82715586406;34740.305193896485;34860.82569587136;25685.486290274464;26871.596926045735;26935;27050.32374190661;27260.454790903674 18:57:38 INFO - PROCESS | 27266 | |2;jquery.html;346.9531613232213;364.925190335981;373.9177380976185;378.45502476433927;388.5842148900676;14379.2810359482;18305;19217.23131074759;19419;20743.273985410513;18281.908590457027;19362;19454.416367508962;19568.11943462544;19602.509937251576;5485.9725701371535;5777.335606405275;5793.044147715622;5798.130280457944;5804.245448091742;5554.305711786027;5634;5725.370209276976;5809;5852.736626851802;5814.738336774834;5815.883682326351;5820.35976042635;5822.796202132926;5829.271341082364;5693.146028095777;5721.742521586497;5826.679532625725;5855.912161317584;5872.530197584204;5588.832335029955;5628.690422026787;5633.40849210831;5634.6337488063145;5643.746031428595;21791.67312490314;22054.228102016514;22300.107995680155;22531.662025069636;22692.65961010586;2187.3437968609514;2199.373178644095;2219.04581030157;2262.7058482397347;2320.3271051395077;9459.574319155585;9876.901230987742;9981.251406144569;10362.481875906175;10500.107490863209;1870.485616455472;1870.8596855235776;1873.6721073812027;1876.3714155757837;1910.2931915191468;76261.61869190619;80929;81021.59489202517;81681;82201;10203.693889183336;10225.181985441146;10257.384556926609;10419.280818664836;10428.634997775041;14279.214643194517;14284.642883927985;14328.785068223984;14333.354999025069;14404.207768572829;7112.679929403189;7349.154847192534;7353.227911069368;7377.704891804267;7476.25237476248;6932.064171336906;6977.267386924402;7000;7165.605891676008;7174.354308112295;4162.708610397303;4334.41485399467;4335.609795118391;4341.804618792099;4464.352668862996;1778.2207824570146;1779.590694140355;1791.6506281275288;1804.7112462006016;1827.5887925216987;898.492351821232;902.5893218585528;927.8747369105084;945.163530275711;981.9558119884622;18275.177617007266;19277.90361048186;19606.313779017666;19613;19885.204591816455;906.551257127726;949.349695458613;960.7790208252142;966.9129778319985;1006.3408467453829;10285.897141028643;10391;10788.784224315626;10870.510827012804;10871.891281087246;417990;419976;438879;440724;440993;93222.53388733012;93773.5311323439;94069;94857.52571237237;95302.52348738212;996.4121168510613;1038.6105210546045;1050.8844027156854;1051.2168434516182;1059.920505962056;16544.255508501905;16670.833291666928;16713.832861671715;17134.485965420557;18006.72989905179;42106.789466052476;42125.789371054176;42586.361204581335;42735.7863210682;43083.707488775384;57617;58171.41828581829;59448.70275648594;59518.40481595302;59880;8079.636416361161;8237.79405514843;8392.16078392156;8635.222829945335;8823.955880220557;10121.949390253001;12909.354532273537;13286.734265314833;13342.332883355988;13390.464381424634;11147.498362573542;11323.773524529628;11498;11646.534138634359;11940.820887686865;11217.775644486901;11259.662210133709;11464.541418343506;11622.535098595961;11826.940865295619;11750;11898.583549575724;11959.282443053444;11976;11976.640700778991;8273.46222495536;8336.166383361859;8351.29014033814;8435.325173985944;8623.56882155877;9937;11312.6040588579;11657.941710291394;12114.454849531969;12212.694682633006 18:57:38 INFO - PROCESS | 27266 | |3;mootools.html;1335.812986181934;1455.8107446032013;1479.1199236454308;1600.631854673425;1743.7820272465933;7417.554946703195;8536.274416674582;8833.602487888045;8841.557922103884;8859.645614175426;8640.265577425926;8679.175478329564;8693.217610415062;8695.69565065223;8713.73858784236;2230.4795580993537;2234.553089382122;2256.007356763027;2256.582532231534;2263.524659821431;2159.924402645908;2191.441182498461;2275.2946586558137;2285.211601997308;2292.7821856923565;2231.4309850988056;2239.070785623964;2246.865188088712;2247.2471721973156;2265.2977576951116;2162.740471143457;2183.2467798609455;2186.202036256771;2188.682641017044;2190.4304880730965;2142.475093602062;2144.5925274197853;2149;2152.4726442021647;2155.633542297813;8516.361272904556;8579.914200857975;8630.439021463584;8656.394052416334;8656.740297791077;5009.4239162496415;5221.138512145491;5222.817201397933;5231.738413079331;5271.446498117719;3178.253110519026;3364.764466487347;3401.897943061712;3437.9828100859336;3440.827958602085;973.6154219083493;1029.5109822834095;1032.633415137623;1047.8952104789537;1076.5263284154946;11648.94175529117;11737.237079589799;11758.000569951564;11785.116116291227;11852.051835853024;4188.748675079505;4236.406903033578;4283.421738065384;4449.466064072332;4465.307877279027;9531.285153613368;9562.378445401027;9562.426254424758;9575.377600456088;9587.328886977984;4911.582515486152;4921.990991846663;4958.1323268428605;4987.077390682735;4996.475370086088;3748.887533374003;4010.3783913493453;4132;4640.141573808856;4640.559146881108;3310.9172270693425;3587.6232995535615;3644.3075815594952;3658.908527286839;3678.6137455567314;1067.9519421626046;1102.1238115698038;1106.6071544601712;1110.3559935237543;1111.5164903267105;780.9140994490601;874.8906386701663;903.1104362203224;910.3536489092818;939.0515579264855;5642.71786410686;5738.225339579187;5747.770089196469;5755;6047.03247480401;929.7582628516634;939.3143005605946;939.4504215034282;950.396498223633;958.3866325551653;3902.2585708715255;3926.5680775114715;3946.2304850553865;3983.462232598562;4004.0990777074926;10458.895411045944;10814.837777433344;10821.9458902705;10824.56701731922;10841.83737243942;10638.882917293728;10744.462776861126;10753.301035432673;10757.623483178051;10771.6229931952;7884.842303153905;7888.881666775003;7907.960460197777;7917.445778795429;8005.679772809139;5576.553875690016;5620.522255608155;5755.71221438918;5763.164341170591;5782.190493330853;9366.157045865904;9701.805963880824;9722.854157187789;9832.60669573209;9972.800543989224;8870.15733505316;9881.456519891475;10096.545655445376;10097.949510252402;10194.388336699822;6600.372964568358;6836.145481814773;6915.585064896122;6974.511784175059;7180.60506672138;8248.010238771385;8255.25702686761;8332.6666933322;8388.286995605198;8392.66429342844;7482.625868706652;7586.165521792709;7659.310662040443;7670.8849367260655;7830.2169783021245;7152.9284707152265;7260.346568808833;7302.671379788028;7534.35957943559;7564.848703025798;6625.50308726857;6925.549839260432;7035.929640703732;7051.224365319913;7057.752978645723;4757;4844.394450693663;4946.134426475424;5035.446100928968;5223.973880130575;5039.823606173766;5058.494150585059;5095.643304968617;5109.208072748581;5186.196139598368 18:57:38 INFO - PROCESS | 27266 | |4;prototype.html;308.82088388734553;314.4936651990296;321.60121449402743;325.2373184881452;327.92293810954436;5109.080365534202;5251.212318152279;5311.73441327934;5330.640686624915;5334.466553344663;5044.772985215665;5114.411842638097;5138.254953031808;5160.329157209558;5177.818776342829;4079.3880917862334;4097.364908439196;4098.344264917614;4107.507099148106;4115.732477388975;3992.2215168042244;4106.876793696194;4120.629143377096;4128.069070959622;4134.441850350209;4033.919321613566;4046.089629833293;4054.8378064877515;4060.9187816243657;4064.2887494688457;4035.3139966205667;4040.8585699500377;4042.858499952517;4045.4538637284177;4050.7569545827346;3449.862005519776;3562.750607457479;3566.3402270580027;3570.982145089284;3584.6594573515476;5071.275766239496;5115.386153661547;5119.923201151985;5125.359330083739;5133.279361938179;4626.653001024936;4633.7683115844075;4640.69835460694;4644.419447569054;4666.39336886206;5281.63028587999;5423.430539793304;5433.103537916279;5474.808381706661;5487.5609951203805;3910.061585219555;3915.158240978203;3915.6280153385383;3921.5882332354977;3935.5670876203594;5666.769941133555;5670.404607516234;5690.573207009449;5694.544436445116;5704.286964129484;3813.1801662642665;3984.960150398517;3987.980060099739;3993.880183594497;4005.516579720592;4062.435962154592;4064.9796751016056;4065.6137666921595;4067.430559721641;4073.8777836664353;4646.814127434933;4651.534846515389;4654.417498050679;4657.068586282757;4666.346711460398;5256.658317209369;5538.344692503009;5543.0344765550235;5549.417311182348;5563.276774019432;1314.6187605594462;1338.8393392792732;1346.3066520741825;1377.8759911608004;1384.1279993603964;931.1991687149047;932.1424289653535;951.110711484764;962.4081190068058;964.320154291223;5269.341332333458;5277.445868183862;5284.524392804666;5303.549198318186;5306.522412982773;5582.385937546866;5598.872428477152;5605.8037968671715;5616.213730077792;5626.803061892814;5147.716875571805;5279.498447647467;5306.310179676694;5311.521963023347;5397.70312632809;2991.2073300575366;3018.9245268868453;3019.39612077581;3019.426309001283;3025.667176610571;5861.531077513789;5864.2083318752275;5866.589338746332;5892.467958330779;5928.703564821828;5592.664440133605;5710.65736055838;5764.538836893039;5779.248697669276;5797.420257974169;5799.3620701722775;5806.970965145148;5835.67903765297;5851.473367396955;5876.383994401574;5485.573750824894;5666.405027472056;5698.458646428583;5701.173329867229;5715.514181294637;5620.206360706425;5652.463016013472;5658.151277308437;5676.517496012885;5686.601937864475;5825.621334613236;5891.646501209942;5894.616849904914;5895.7052147391605;5907.970460147843;3924.3917192835156;3995.600439955981;4027.7180597357906;4034.6772258219858;4049.1294371710223;5426.728663566727;5705.258316418839;5709.173958890376;5720.74256658443;5721.22763426932;5427.457254274541;5473.698946557977;5572.582056345871;5576.609637325349;5596.384397716167;5544.805931792368;5553.888922221614;5558.887622703347;5579.302587176603;5583.525400341016;5306.487651019441;5482.451754824486;5499.50504454601;5509.146082357241;5524.48076778889;5509.393966663583;5591.120572905039;5624.521915637217;5624.750099959885;5628.155776633538;5488.890222195613;5496.230527726041;5514.91727624094;5523.309586301712;5534.201384550118 18:57:38 INFO - PROCESS | 27266 | |5;yui.html;642.575899906062;754.830163213277;763.446501286567;770.1143684762526;774.8792652996592;14375.353109110089;15175.84824151761;16596.50210493684;16695.666086678273;16760.32958681651;12754.170978886366;12915.741685166291;12916.354182290896;12928.353582320893;12935.159214651041;795.7413840501846;817.2889586060106;817.5299202958294;818.7257268814955;818.8075802186481;681.935216154467;694.0630149298457;793.4049462902823;816.391788117853;820.0405525535139;861.6725644255174;862.7023676831483;863.9395242333007;864.7838040489878;865.0138841720444;854.7393045121236;855.0850589868843;855.102142750113;855.1320409784074;855.4012191465968;508.5194491205812;519.4908989190615;609.4545381883235;622.1445512420422;623.2769986815273;12912.54806081792;12995.935020324932;13038.15252008626;13117.278549679764;13124.278164700938;13725.45098196071;14171.64570885736;14328.211948342838;14439.566812995627;14480.71038579233;12787.232766034067;12974.221546707227;13073.411696473682;13233.801492977613;13279.668008299774;4364.432623758923;4376.343548467756;4428.092241090569;4469.888252793674;4619.976900115512;75272;77058.6147069261;77242.61378693127;77429.61285193538;79818.6009069951;10884.673459796219;10989.560417583367;11167.106631469464;11194.328340299608;11433.656990290305;19184.328548500736;19220.615587688448;19235.65350425457;19361.612767744566;19388.12753426099;8007.7998050048045;8044.597770111471;8106.918930810734;8208.794780130545;8250.092489826115;4267.594578515098;4285.1643929434085;4373.2128216921255;4417.425734654538;4421.889452763642;3332.6334103248623;3416.299658569987;3419.4357930941615;3419.452887537982;3455.9654403456148;532.0901258847337;545;547.3814589513903;548.7585462396612;565.4882331490008;466.4985140973467;549.4779959038929;575.7524264566276;588.8910551547978;591.6480841277746;7831.882521762178;7921.287084162338;8038.919610803817;8195.836083278302;8317.168283171755;554.9167624856303;601.8946684330225;602.4246844263718;606.5178183344252;608.0726891490424;3911.647951684362;4016.7991600419864;4137.97931010349;4139.2963196256105;4169.395437661522;113899.43050284861;114117.4294128524;114257;114469.71060578742;116563;94959.52520237355;96903.5774105653;101218;101549;103080;63700;83474.58262708769;84953.15046849576;87305.69041464383;87841;7386.96306518464;7587.089549254125;7648.617569121633;7684.385249179941;7870.29167374939;51140.23289650584;51141.073133664344;51650.74174629103;52027.21959170691;53008.20487692611;61927;63605.36394635995;73121;76321.23678763364;77374.61312693401;12168.391580421121;12415.93792031034;12433.93783031079;12536.310502922426;13252.138610990254;12786.168899021533;13048.151870128411;13273.867261327649;13575.782930910656;13854.376553054935;12009.279443233434;12098.153129281218;12247.121455986133;12413.627591172279;12709.364531773559;12842.807357889453;12879.420426081037;13057.542985995444;13061.08572399923;13310.86689133135;11549.841143765094;11655.825162622397;11792.469338879599;11944.64166075019;12191.207571507824;10015.949920250352;10404.271700980858;10712.625058122929;10764.25511494564;10863.67408977732;9679;10464.215183861088;10633.308834925705;10697.197710171924;10717.35695858251 18:57:38 INFO - PROCESS | 27266 | __end_tp_report 18:57:38 INFO - PROCESS | 27266 | __start_cc_report 18:57:38 INFO - PROCESS | 27266 | _x_x_mozilla_cycle_collect,1366 18:57:38 INFO - PROCESS | 27266 | __end_cc_report 18:57:38 INFO - PROCESS | 27266 | __startTimestamp1476755858850__endTimestamp 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | ------- Summary: start ------- 18:57:38 INFO - PROCESS | 27266 | Number of tests: 6 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | [#0] dojo.html Cycles:165 Average:5273.46 Median:5458.75 stddev:594.18 (10.9%) stddev-sans-first:568.63 18:57:38 INFO - PROCESS | 27266 | Values: 3000.8 3004.7 3045.6 3047.9 3050.6 5083.9 5192.2 5193.7 5207.9 5340.4 5213.2 5215.7 5363.3 5378.8 5411.7 4838.9 4862.0 4911.0 4933.6 4945.4 4884.3 4951.8 5026.5 5030.9 5064.3 4687.1 4730.7 4889.0 4931.1 4961.3 4784.1 4795.2 4843.4 4863.8 4911.2 4789.3 4823.5 4827.7 4834.8 4884.5 5293.0 5297.7 5299.2 5300.4 5311.7 5432.0 5502.8 5508.1 5588.6 5705.1 5620.5 5627.0 5636.5 5636.7 5645.4 5199.9 5250.7 5260.1 5266.0 5354.8 5870.3 5889.4 5939.3 5998.2 5999.3 5699.2 5703.2 5704.0 5705.5 5712.1 5432.0 5490.9 5770.6 5771.0 5773.5 5388.4 5621.4 5674.1 5691.5 5755.0 5696.6 5703.4 5704.8 5706.1 5774.3 4250.4 4421.7 4426.5 4431.4 4484.2 3846.9 3888.8 3919.5 3944.1 3951.0 5473.3 5474.4 5476.7 5486.4 5539.0 5810.8 5813.1 5818.9 5823.6 5824.5 5167.1 5189.6 5192.6 5292.6 5458.8 4827.6 4895.5 4896.0 4932.4 5011.4 5836.7 5842.1 5894.3 5896.1 5941.9 5713.5 5715.0 5717.7 5719.6 5721.7 5519.8 5650.2 5737.0 5802.6 5862.6 5526.9 5543.0 5546.2 5599.0 5602.2 5642.8 5644.2 5651.3 5658.0 5659.2 5308.5 5364.9 5445.1 5492.0 5538.9 5388.1 5503.5 5532.9 5569.1 5595.9 5489.4 5499.3 5505.3 5506.3 5508.1 5285.5 5329.1 5562.4 5591.6 5646.4 5376.6 5419.7 5422.8 5450.5 5509.9 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | [#1] ext.html Cycles:180 Average:57692.70 Median:36416.45 stddev:115505.16 (317.2%) stddev-sans-first:115749.48 18:57:38 INFO - PROCESS | 27266 | Values: 542.7 580.2 598.7 610.2 615.5 31106.2 41835.8 42733.3 42767.4 42853.6 43058.6 43493.1 43495.8 43513.0 43533.0 8149.7 8615.6 8820.3 8888.6 8919.4 7940.3 10446.2 10697.3 10698.3 10966.0 10838.9 10879.0 10910.2 10919.9 10926.2 10542.7 10608.2 10611.6 10613.0 10627.5 10539.1 10552.1 10600.7 10600.9 10614.5 40184.4 40526.2 40587.2 40675.2 41001.8 3137.1 3154.7 3476.7 3504.3 4050.5 30358.4 30807.8 30842.7 31330.8 31733.4 3891.8 3938.1 3982.9 4104.1 4127.4 324839.0 325826.0 328873.0 329543.0 330500.0 32727.5 55118.7 55392.5 55403.7 55449.0 34230.5 36409.6 36423.3 36434.5 36441.3 13169.8 13199.7 13254.3 13286.7 13292.9 9271.2 9415.0 10456.0 10796.5 10922.9 8038.5 8093.5 8134.8 8219.7 8233.0 2980.8 3050.5 3105.1 3180.2 3240.4 982.4 1002.6 1008.2 1036.9 1065.4 30979.8 30989.5 31521.4 31556.5 32062.7 1027.7 1076.5 1078.4 1107.6 1121.9 15900.7 16699.2 16745.2 16782.9 16829.9 469949.0 474898.0 475318.0 475692.0 476203.0 55039.0 55269.7 55285.2 55294.5 55320.4 1178.0 1188.6 1191.3 1215.1 1216.6 30743.8 33875.0 33959.5 34107.8 34637.0 51692.5 52246.5 53887.7 54055.7 59123.0 481692.0 484464.0 484729.0 485192.0 490773.0 26095.6 27382.6 41556.0 41814.6 42311.8 44347.8 45501.8 45514.3 45596.5 45881.5 38160.1 38441.2 38442.6 38867.4 40133.2 38675.0 38949.4 39250.0 39961.8 40486.6 38329.8 38879.4 39032.6 39206.6 39315.4 31815.7 34519.5 34568.8 34740.3 34860.8 25685.5 26871.6 26935.0 27050.3 27260.5 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | [#2] jquery.html Cycles:180 Average:27273.24 Median:2275.65 stddev:71669.13 (3149.4%) stddev-sans-first:71841.67 18:57:38 INFO - PROCESS | 27266 | Values: 347.0 364.9 373.9 378.5 388.6 14379.3 18305.0 19217.2 19419.0 20743.3 18281.9 19362.0 19454.4 19568.1 19602.5 5486.0 5777.3 5793.0 5798.1 5804.2 5554.3 5634.0 5725.4 5809.0 5852.7 5814.7 5815.9 5820.4 5822.8 5829.3 5693.1 5721.7 5826.7 5855.9 5872.5 5588.8 5628.7 5633.4 5634.6 5643.7 21791.7 22054.2 22300.1 22531.7 22692.7 2187.3 2199.4 2219.0 2262.7 2320.3 9459.6 9876.9 9981.3 10362.5 10500.1 1870.5 1870.9 1873.7 1876.4 1910.3 76261.6 80929.0 81021.6 81681.0 82201.0 10203.7 10225.2 10257.4 10419.3 10428.6 14279.2 14284.6 14328.8 14333.4 14404.2 7112.7 7349.2 7353.2 7377.7 7476.3 6932.1 6977.3 7000.0 7165.6 7174.4 4162.7 4334.4 4335.6 4341.8 4464.4 1778.2 1779.6 1791.7 1804.7 1827.6 898.5 902.6 927.9 945.2 982.0 18275.2 19277.9 19606.3 19613.0 19885.2 906.6 949.3 960.8 966.9 1006.3 10285.9 10391.0 10788.8 10870.5 10871.9 417990.0 419976.0 438879.0 440724.0 440993.0 93222.5 93773.5 94069.0 94857.5 95302.5 996.4 1038.6 1050.9 1051.2 1059.9 16544.3 16670.8 16713.8 17134.5 18006.7 42106.8 42125.8 42586.4 42735.8 43083.7 57617.0 58171.4 59448.7 59518.4 59880.0 8079.6 8237.8 8392.2 8635.2 8824.0 10121.9 12909.4 13286.7 13342.3 13390.5 11147.5 11323.8 11498.0 11646.5 11940.8 11217.8 11259.7 11464.5 11622.5 11826.9 11750.0 11898.6 11959.3 11976.0 11976.6 8273.5 8336.2 8351.3 8435.3 8623.6 9937.0 11312.6 11657.9 12114.5 12212.7 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | [#3] mootools.html Cycles:180 Average:5581.30 Median:5022.44 stddev:3208.31 (63.9%) stddev-sans-first:3201.44 18:57:38 INFO - PROCESS | 27266 | Values: 1335.8 1455.8 1479.1 1600.6 1743.8 7417.6 8536.3 8833.6 8841.6 8859.6 8640.3 8679.2 8693.2 8695.7 8713.7 2230.5 2234.6 2256.0 2256.6 2263.5 2159.9 2191.4 2275.3 2285.2 2292.8 2231.4 2239.1 2246.9 2247.2 2265.3 2162.7 2183.2 2186.2 2188.7 2190.4 2142.5 2144.6 2149.0 2152.5 2155.6 8516.4 8579.9 8630.4 8656.4 8656.7 5009.4 5221.1 5222.8 5231.7 5271.4 3178.3 3364.8 3401.9 3438.0 3440.8 973.6 1029.5 1032.6 1047.9 1076.5 11648.9 11737.2 11758.0 11785.1 11852.1 4188.7 4236.4 4283.4 4449.5 4465.3 9531.3 9562.4 9562.4 9575.4 9587.3 4911.6 4922.0 4958.1 4987.1 4996.5 3748.9 4010.4 4132.0 4640.1 4640.6 3310.9 3587.6 3644.3 3658.9 3678.6 1068.0 1102.1 1106.6 1110.4 1111.5 780.9 874.9 903.1 910.4 939.1 5642.7 5738.2 5747.8 5755.0 6047.0 929.8 939.3 939.5 950.4 958.4 3902.3 3926.6 3946.2 3983.5 4004.1 10458.9 10814.8 10821.9 10824.6 10841.8 10638.9 10744.5 10753.3 10757.6 10771.6 7884.8 7888.9 7908.0 7917.4 8005.7 5576.6 5620.5 5755.7 5763.2 5782.2 9366.2 9701.8 9722.9 9832.6 9972.8 8870.2 9881.5 10096.5 10097.9 10194.4 6600.4 6836.1 6915.6 6974.5 7180.6 8248.0 8255.3 8332.7 8388.3 8392.7 7482.6 7586.2 7659.3 7670.9 7830.2 7152.9 7260.3 7302.7 7534.4 7564.8 6625.5 6925.5 7035.9 7051.2 7057.8 4757.0 4844.4 4946.1 5035.4 5224.0 5039.8 5058.5 5095.6 5109.2 5186.2 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | [#4] prototype.html Cycles:180 Average:4638.03 Median:5306.40 stddev:1377.05 (26.0%) stddev-sans-first:1342.02 18:57:38 INFO - PROCESS | 27266 | Values: 308.8 314.5 321.6 325.2 327.9 5109.1 5251.2 5311.7 5330.6 5334.5 5044.8 5114.4 5138.3 5160.3 5177.8 4079.4 4097.4 4098.3 4107.5 4115.7 3992.2 4106.9 4120.6 4128.1 4134.4 4033.9 4046.1 4054.8 4060.9 4064.3 4035.3 4040.9 4042.9 4045.5 4050.8 3449.9 3562.8 3566.3 3571.0 3584.7 5071.3 5115.4 5119.9 5125.4 5133.3 4626.7 4633.8 4640.7 4644.4 4666.4 5281.6 5423.4 5433.1 5474.8 5487.6 3910.1 3915.2 3915.6 3921.6 3935.6 5666.8 5670.4 5690.6 5694.5 5704.3 3813.2 3985.0 3988.0 3993.9 4005.5 4062.4 4065.0 4065.6 4067.4 4073.9 4646.8 4651.5 4654.4 4657.1 4666.3 5256.7 5538.3 5543.0 5549.4 5563.3 1314.6 1338.8 1346.3 1377.9 1384.1 931.2 932.1 951.1 962.4 964.3 5269.3 5277.4 5284.5 5303.5 5306.5 5582.4 5598.9 5605.8 5616.2 5626.8 5147.7 5279.5 5306.3 5311.5 5397.7 2991.2 3018.9 3019.4 3019.4 3025.7 5861.5 5864.2 5866.6 5892.5 5928.7 5592.7 5710.7 5764.5 5779.2 5797.4 5799.4 5807.0 5835.7 5851.5 5876.4 5485.6 5666.4 5698.5 5701.2 5715.5 5620.2 5652.5 5658.2 5676.5 5686.6 5825.6 5891.6 5894.6 5895.7 5908.0 3924.4 3995.6 4027.7 4034.7 4049.1 5426.7 5705.3 5709.2 5720.7 5721.2 5427.5 5473.7 5572.6 5576.6 5596.4 5544.8 5553.9 5558.9 5579.3 5583.5 5306.5 5482.5 5499.5 5509.1 5524.5 5509.4 5591.1 5624.5 5624.8 5628.2 5488.9 5496.2 5514.9 5523.3 5534.2 18:57:38 INFO - PROCESS | 27266 | 18:57:38 INFO - PROCESS | 27266 | [#5] yui.html Cycles:180 Average:20146.50 Median:4374.78 stddev:29703.43 (679.0%) stddev-sans-first:29750.66 18:57:38 INFO - PROCESS | 27266 | Values: 642.6 754.8 763.4 770.1 774.9 14375.4 15175.8 16596.5 16695.7 16760.3 12754.2 12915.7 12916.4 12928.4 12935.2 795.7 817.3 817.5 818.7 818.8 681.9 694.1 793.4 816.4 820.0 861.7 862.7 863.9 864.8 865.0 854.7 855.1 855.1 855.1 855.4 508.5 519.5 609.5 622.1 623.3 12912.5 12995.9 13038.2 13117.3 13124.3 13725.5 14171.6 14328.2 14439.6 14480.7 12787.2 12974.2 13073.4 13233.8 13279.7 4364.4 4376.3 4428.1 4469.9 4620.0 75272.0 77058.6 77242.6 77429.6 79818.6 10884.7 10989.6 11167.1 11194.3 11433.7 19184.3 19220.6 19235.7 19361.6 19388.1 8007.8 8044.6 8106.9 8208.8 8250.1 4267.6 4285.2 4373.2 4417.4 4421.9 3332.6 3416.3 3419.4 3419.5 3456.0 532.1 545.0 547.4 548.8 565.5 466.5 549.5 575.8 588.9 591.6 7831.9 7921.3 8038.9 8195.8 8317.2 554.9 601.9 602.4 606.5 608.1 3911.6 4016.8 4138.0 4139.3 4169.4 113899.4 114117.4 114257.0 114469.7 116563.0 94959.5 96903.6 101218.0 101549.0 103080.0 63700.0 83474.6 84953.2 87305.7 87841.0 7387.0 7587.1 7648.6 7684.4 7870.3 51140.2 51141.1 51650.7 52027.2 53008.2 61927.0 63605.4 73121.0 76321.2 77374.6 12168.4 12415.9 12433.9 12536.3 13252.1 12786.2 13048.2 13273.9 13575.8 13854.4 12009.3 12098.2 12247.1 12413.6 12709.4 12842.8 12879.4 13057.5 13061.1 13310.9 11549.8 11655.8 11792.5 11944.6 12191.2 10015.9 10404.3 10712.6 10764.3 10863.7 9679.0 10464.2 10633.3 10697.2 10717.4 18:57:38 INFO - PROCESS | 27266 | -------- Summary: end -------- 18:57:38 INFO - PROCESS | 27266 | 18:57:39 INFO - TEST-INFO | 27266: exit 0 18:57:39 INFO - TEST-OK | dromaeo_css | took 1117117ms 18:57:39 INFO - TEST-START | kraken 18:57:39 INFO - operating with platform_type : linux_ 18:57:39 INFO - Initialising browser for kraken test... 18:57:39 INFO - TEST-INFO | started process 27574 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFH3a6v/profile http://localhost:33975/getInfo.html) 18:57:43 INFO - PROCESS | 27574 | __metrics Screen width/height:1600/1200 18:57:43 INFO - PROCESS | 27574 | colorDepth:24 18:57:43 INFO - PROCESS | 27574 | Browser inner width/height: 1024/697 18:57:43 INFO - PROCESS | 27574 | __metrics 18:57:44 INFO - PROCESS | 27574 | 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" 18:57:44 INFO - PROCESS | 27574 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:57:44 INFO - PROCESS | 27574 | console.error: PushService: 18:57:44 INFO - PROCESS | 27574 | stateChangeProcessEnqueue: Error transitioning state 18:57:44 INFO - PROCESS | 27574 | UnknownError 18:57:45 INFO - TEST-INFO | 27574: exit 0 18:57:45 INFO - Browser initialized. 18:57:45 INFO - Running cycle 1/1 for kraken test... 18:57:45 INFO - TEST-INFO | started process 27657 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFH3a6v/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:57:57 INFO - PROCESS | 27657 | RSS: Main: 172089344 18:57:57 INFO - PROCESS | 27657 | 18:57:59 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:33975/tests/kraken/driver.html?testName=audio-beat-detection) 18:58:00 INFO - PROCESS | 27657 | RSS: Main: 237813760 18:58:00 INFO - PROCESS | 27657 | 18:58:03 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:33975/tests/kraken/driver.html?testName=audio-dft) 18:58:04 INFO - PROCESS | 27657 | RSS: Main: 216342528 18:58:04 INFO - PROCESS | 27657 | 18:58:07 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:33975/tests/kraken/driver.html?testName=audio-fft) 18:58:07 INFO - PROCESS | 27657 | RSS: Main: 298225664 18:58:07 INFO - PROCESS | 27657 | 18:58:09 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:33975/tests/kraken/driver.html?testName=audio-oscillator) 18:58:10 INFO - PROCESS | 27657 | RSS: Main: 209174528 18:58:10 INFO - PROCESS | 27657 | 18:58:12 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:33975/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:58:13 INFO - PROCESS | 27657 | RSS: Main: 211845120 18:58:13 INFO - PROCESS | 27657 | 18:58:16 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:33975/tests/kraken/driver.html?testName=imaging-darkroom) 18:58:16 INFO - PROCESS | 27657 | RSS: Main: 248045568 18:58:16 INFO - PROCESS | 27657 | 18:58:20 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:33975/tests/kraken/driver.html?testName=imaging-desaturate) 18:58:20 INFO - PROCESS | 27657 | RSS: Main: 247033856 18:58:20 INFO - PROCESS | 27657 | 18:58:23 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:33975/tests/kraken/driver.html?testName=json-parse-financial) 18:58:23 INFO - PROCESS | 27657 | RSS: Main: 246546432 18:58:23 INFO - PROCESS | 27657 | 18:58:25 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:33975/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:58:26 INFO - PROCESS | 27657 | RSS: Main: 208596992 18:58:26 INFO - PROCESS | 27657 | 18:58:27 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:58:28 INFO - PROCESS | 27657 | RSS: Main: 215920640 18:58:28 INFO - PROCESS | 27657 | 18:58:30 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:58:31 INFO - PROCESS | 27657 | RSS: Main: 226422784 18:58:31 INFO - PROCESS | 27657 | 18:58:33 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:58:34 INFO - PROCESS | 27657 | RSS: Main: 234610688 18:58:34 INFO - PROCESS | 27657 | 18:58:37 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:58:37 INFO - PROCESS | 27657 | RSS: Main: 231038976 18:58:37 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | Cycle 1(1): loaded http://localhost:33975/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:33975/tests/kraken/driver.html?testName=ai-astar) 18:58:39 INFO - PROCESS | 27657 | RSS: Main: 281686016 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | __start_tp_report 18:58:39 INFO - PROCESS | 27657 | _x_x_mozilla_page_load 18:58:39 INFO - PROCESS | 27657 | _x_x_mozilla_page_load_details 18:58:39 INFO - PROCESS | 27657 | |i|pagename|runs| 18:58:39 INFO - PROCESS | 27657 | |0;ai-astar;103;112;113;111;112;112;111;111;109;110 18:58:39 INFO - PROCESS | 27657 | |1;audio-beat-detection;147;123;124;169;123;128;122;124;160;125 18:58:39 INFO - PROCESS | 27657 | |2;audio-dft;161;161;161;160;160;162;162;163;161;162 18:58:39 INFO - PROCESS | 27657 | |3;audio-fft;75;76;77;112;78;76;76;75;100;76 18:58:39 INFO - PROCESS | 27657 | |4;audio-oscillator;83;83;129;84;84;83;113;82;82;114 18:58:39 INFO - PROCESS | 27657 | |5;imaging-gaussian-blur;118;117;117;118;117;117;117;117;117;117 18:58:39 INFO - PROCESS | 27657 | |6;imaging-darkroom;146;146;145;146;145;145;146;145;145;145 18:58:39 INFO - PROCESS | 27657 | |7;imaging-desaturate;84;84;85;85;85;84;85;84;85;85 18:58:39 INFO - PROCESS | 27657 | |8;json-parse-financial;54;52;52;52;53;55;54;53;55;53 18:58:39 INFO - PROCESS | 27657 | |9;json-stringify-tinderbox;60;61;60;61;60;60;60;59;60;61 18:58:39 INFO - PROCESS | 27657 | |10;stanford-crypto-aes;87;80;81;80;82;81;79;79;83;80 18:58:39 INFO - PROCESS | 27657 | |11;stanford-crypto-ccm;130;130;131;130;136;135;136;134;172;137 18:58:39 INFO - PROCESS | 27657 | |12;stanford-crypto-pbkdf2;165;164;163;169;165;166;169;164;169;167 18:58:39 INFO - PROCESS | 27657 | |13;stanford-crypto-sha256-iterative;67;67;66;66;65;67;65;67;68;64 18:58:39 INFO - PROCESS | 27657 | __end_tp_report 18:58:39 INFO - PROCESS | 27657 | __start_cc_report 18:58:39 INFO - PROCESS | 27657 | _x_x_mozilla_cycle_collect,1685 18:58:39 INFO - PROCESS | 27657 | __end_cc_report 18:58:39 INFO - PROCESS | 27657 | __startTimestamp1476755919787__endTimestamp 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | ------- Summary: start ------- 18:58:39 INFO - PROCESS | 27657 | Number of tests: 14 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#0] ai-astar Cycles:10 Average:110.40 Median:111.50 stddev:2.84 (2.5%) stddev-sans-first:1.20 18:58:39 INFO - PROCESS | 27657 | Values: 103.0 112.0 113.0 111.0 112.0 112.0 111.0 111.0 109.0 110.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#1] audio-beat-detection Cycles:10 Average:134.50 Median:126.50 stddev:17.55 (13.9%) stddev-sans-first:18.02 18:58:39 INFO - PROCESS | 27657 | Values: 147.0 123.0 124.0 169.0 123.0 128.0 122.0 124.0 160.0 125.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:0.95 (0.6%) stddev-sans-first:1.00 18:58:39 INFO - PROCESS | 27657 | Values: 161.0 161.0 161.0 160.0 160.0 162.0 162.0 163.0 161.0 162.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#3] audio-fft Cycles:10 Average:82.10 Median:76.00 stddev:12.94 (17.0%) stddev-sans-first:13.47 18:58:39 INFO - PROCESS | 27657 | Values: 75.0 76.0 77.0 112.0 78.0 76.0 76.0 75.0 100.0 76.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#4] audio-oscillator Cycles:10 Average:93.70 Median:83.00 stddev:17.75 (21.4%) stddev-sans-first:18.40 18:58:39 INFO - PROCESS | 27657 | Values: 83.0 83.0 129.0 84.0 84.0 83.0 113.0 82.0 82.0 114.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 18:58:39 INFO - PROCESS | 27657 | Values: 118.0 117.0 117.0 118.0 117.0 117.0 117.0 117.0 117.0 117.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#6] imaging-darkroom Cycles:10 Average:145.40 Median:145.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 18:58:39 INFO - PROCESS | 27657 | Values: 146.0 146.0 145.0 146.0 145.0 145.0 146.0 145.0 145.0 145.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#7] imaging-desaturate Cycles:10 Average:84.60 Median:85.00 stddev:0.52 (0.6%) stddev-sans-first:0.50 18:58:39 INFO - PROCESS | 27657 | Values: 84.0 84.0 85.0 85.0 85.0 84.0 85.0 84.0 85.0 85.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#8] json-parse-financial Cycles:10 Average:53.30 Median:53.50 stddev:1.16 (2.2%) stddev-sans-first:1.20 18:58:39 INFO - PROCESS | 27657 | Values: 54.0 52.0 52.0 52.0 53.0 55.0 54.0 53.0 55.0 53.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#9] json-stringify-tinderbox Cycles:10 Average:60.20 Median:60.00 stddev:0.63 (1.1%) stddev-sans-first:0.67 18:58:39 INFO - PROCESS | 27657 | Values: 60.0 61.0 60.0 61.0 60.0 60.0 60.0 59.0 60.0 61.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#10] stanford-crypto-aes Cycles:10 Average:81.20 Median:81.00 stddev:2.39 (3.0%) stddev-sans-first:1.33 18:58:39 INFO - PROCESS | 27657 | Values: 87.0 80.0 81.0 80.0 82.0 81.0 79.0 79.0 83.0 80.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#11] stanford-crypto-ccm Cycles:10 Average:137.10 Median:135.50 stddev:12.57 (9.3%) stddev-sans-first:13.07 18:58:39 INFO - PROCESS | 27657 | Values: 130.0 130.0 131.0 130.0 136.0 135.0 136.0 134.0 172.0 137.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.10 Median:166.50 stddev:2.28 (1.4%) stddev-sans-first:2.39 18:58:39 INFO - PROCESS | 27657 | Values: 165.0 164.0 163.0 169.0 165.0 166.0 169.0 164.0 169.0 167.0 18:58:39 INFO - PROCESS | 27657 | 18:58:39 INFO - PROCESS | 27657 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.20 Median:67.00 stddev:1.23 (1.8%) stddev-sans-first:1.27 18:58:39 INFO - PROCESS | 27657 | Values: 67.0 67.0 66.0 66.0 65.0 67.0 65.0 67.0 68.0 64.0 18:58:39 INFO - PROCESS | 27657 | -------- Summary: end -------- 18:58:39 INFO - PROCESS | 27657 | 18:58:40 INFO - TEST-INFO | 27657: exit 0 18:58:41 INFO - TEST-OK | kraken | took 61279ms 18:58:41 INFO - SUITE-END | took 1178s 18:58:41 INFO - Completed test suite (00:19:38) 18:58:41 INFO - javascript benchmark 18:58:41 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3000.789944703871, 3004.654464736553, 3045.6192975878016, 3047.9390412191756, 3050.6339239291274, 5083.949160508394, 5192.195209742486, 5193.662411943221, 5207.869803254921, 5340.412554618989, 5213.191955246943, 5215.739213039352, 5363.329583802025, 5378.838634840951, 5411.729413529318, 4838.879028024292, 4861.975690121544, 4911.0, 4933.605311575084, 4945.35710357653, 4884.3406140171155, 4951.801927922878, 5026.522480364378, 5030.899382012358, 5064.290999260106, 4687.062587482517, 4730.739809310487, 4889.022195560902, 4931.112399768041, 4961.305417241589, 4784.067106914154, 4795.160846851822, 4843.443004054544, 4863.756812159378, 4911.18965370717, 4789.2816077588295, 4823.5176482351835, 4827.710337379734, 4834.830780922651, 4884.462709101996, 5293.0, 5297.708626025567, 5299.152135658314, 5300.363956325227, 5311.707856067915, 5432.049391356497, 5502.80740174092, 5508.14623733322, 5588.608797384185, 5705.115707065412, 5620.494155526022, 5627.043402621564, 5636.4927156556105, 5636.689982050985, 5645.350784659776, 5199.948000519984, 5250.7374631268285, 5260.105782017066, 5266.0257852297445, 5354.759035843396, 5870.295564532284, 5889.352171261158, 5939.3466718661775, 5998.220231369894, 5999.340072592011, 5699.202111704365, 5703.201551782754, 5703.971480142573, 5705.5435565154685, 5712.086066229466, 5431.972840135853, 5490.862728431821, 5770.624909380961, 5770.971145144247, 5773.538116950634, 5388.434214407509, 5621.409751976065, 5674.12051132067, 5691.544676425959, 5755.0, 5696.601237913306, 5703.40114288002, 5704.80033198836, 5706.058500347396, 5774.2782152230975, 4250.426192463978, 4421.712588681726, 4426.513083560806, 4431.379606855043, 4484.2376795944765, 3846.9230615387537, 3888.8444462221196, 3919.4904662393706, 3944.053427177457, 3950.9802450987563, 5473.31583552056, 5474.39781624021, 5476.726163691799, 5486.3690675572025, 5539.0, 5810.82567522975, 5813.09896965971, 5818.941810581925, 5823.592348535646, 5824.475797178275, 5167.147420675622, 5189.584833213334, 5192.584593232532, 5292.576593872481, 5458.754356053987, 4827.637927155477, 4895.510448955076, 4895.951040489549, 4932.408111026628, 5011.4236862761245, 5836.708164591669, 5842.094475356326, 5894.2926848778425, 5896.086106653475, 5941.851453713692, 5713.485786279089, 5714.971425142848, 5717.7141142941855, 5719.57103217252, 5721.742521586455, 5519.834404967857, 5650.152477128464, 5736.971315143398, 5802.622829516068, 5862.560307977004, 5526.889462210653, 5543.0, 5546.168074788814, 5599.0, 5602.215689803512, 5642.802501912413, 5644.153376993484, 5651.321841379061, 5658.0, 5659.179418984142, 5308.46915308466, 5364.946350536445, 5445.128779395436, 5492.038893193755, 5538.944610553843, 5388.137897936312, 5503.504684578407, 5532.91700624499, 5569.10894256917, 5595.860103497445, 5489.3687225969525, 5499.257600223918, 5505.311836020497, 5506.311711036121, 5508.14623733322, 5285.5243028126115, 5329.094054010905, 5562.360328562268, 5591.608587398843, 5646.3506696728755, 5376.59675524345, 5419.674819510842, 5422.8373148805595, 5450.482204190595, 5509.889802204014], "value": 5233.602475448631, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [542.7081693323578, 580.2340909998801, 598.6767145741298, 610.179308829624, 615.4553220399945, 31106.222344441372, 41835.79082104589, 42733.29066837323, 42767.35848962268, 42853.57146428535, 43058.56941430585, 43493.13013739731, 43495.78252108743, 43513.0, 43533.0, 8149.674013039471, 8615.56922153893, 8820.294376449869, 8888.555572221396, 8919.375643704943, 7940.2853743163105, 10446.216533759998, 10697.251192416534, 10698.251122421434, 10966.013058824705, 10838.945805271002, 10879.0, 10910.23628346016, 10919.890801092006, 10926.180536459757, 10542.683719488428, 10608.15134789215, 10611.575536978511, 10613.0, 10627.52176152075, 10539.104176145036, 10552.103071238955, 10600.734981625445, 10600.94699526505, 10614.522346494427, 40184.39723404151, 40526.18947621031, 40587.18825623471, 40675.1864962702, 41001.794991025155, 3137.074563003919, 3154.6529881713222, 3476.721862251014, 3504.3166582516164, 4050.4734384529825, 30358.383699015532, 30807.845960770275, 30842.691573084205, 31330.843345783353, 31733.365332693218, 3891.805409729502, 3938.074552480165, 3982.8805135845682, 4104.117614712851, 4127.40152677863, 324839.0, 325826.0, 328873.0, 329543.0, 330500.0, 32727.50908736371, 55118.72440637771, 55392.522009529006, 55403.72298138483, 55449.0, 34230.48654270188, 36409.63590364062, 36423.27153456916, 36434.45348319777, 36441.27117457636, 13169.802452963213, 13199.736005279841, 13254.271015094262, 13286.66783330405, 13292.933535332262, 9271.16559509634, 9414.964353921063, 10456.0, 10796.460176991119, 10922.890771092187, 8038.517688938682, 8093.514389136671, 8134.796630084295, 8219.671213151527, 8233.0, 2980.7629833618807, 3050.542418637222, 3105.1460848266456, 3180.189051791778, 3240.4329242382487, 982.4350998176077, 1002.5688953749811, 1008.178334657252, 1036.896310368957, 1065.3980501016902, 30979.845100774353, 30989.535156972663, 31521.37504187002, 31556.526652100238, 32062.67937320597, 1027.6660085472251, 1076.4671487613682, 1078.4230436716475, 1107.595727559435, 1121.899029087386, 15900.681986360209, 16699.248533816008, 16745.162741863103, 16782.916085419496, 16829.915850420668, 469949.0, 474898.0, 475318.0, 475692.0, 476203.0, 55039.0, 55269.723651381486, 55285.170722439194, 55294.51174697148, 55320.446795532334, 1177.9823302650468, 1188.607759439383, 1191.2852288626755, 1215.1190386969377, 1216.647172320035, 30743.846280768452, 33875.0, 33959.4906076414, 34107.82946085254, 34636.96089117331, 51692.48307517027, 52246.47753522416, 53887.73056134694, 54055.72972135114, 59123.0, 481692.0, 484464.0, 484729.0, 485192.0, 490773.0, 26095.60856587115, 27382.5892611607, 41556.0, 41814.58185418229, 42311.7884410576, 44347.77826110849, 45501.77249113733, 45514.31728524008, 45596.54403455923, 45881.54118458906, 38160.07837962094, 38441.231175376895, 38442.615573843905, 38867.416988745754, 40133.1973360537, 38675.0, 38949.415758763076, 39250.0, 39961.80019099886, 40486.59513404828, 38329.80835095807, 38879.41680874732, 39032.609673902894, 39206.607933921434, 39315.410268846565, 31815.68184318127, 34519.4822077664, 34568.82715586406, 34740.305193896485, 34860.82569587136, 25685.486290274464, 26871.596926045735, 26935.0, 27050.32374190661, 27260.454790903674], "value": 18655.45283791216, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [346.9531613232213, 364.925190335981, 373.9177380976185, 378.45502476433927, 388.5842148900676, 14379.2810359482, 18305.0, 19217.23131074759, 19419.0, 20743.273985410513, 18281.908590457027, 19362.0, 19454.416367508962, 19568.11943462544, 19602.509937251576, 5485.9725701371535, 5777.335606405275, 5793.044147715622, 5798.130280457944, 5804.245448091742, 5554.305711786027, 5634.0, 5725.370209276976, 5809.0, 5852.736626851802, 5814.738336774834, 5815.883682326351, 5820.35976042635, 5822.796202132926, 5829.271341082364, 5693.146028095777, 5721.742521586497, 5826.679532625725, 5855.912161317584, 5872.530197584204, 5588.832335029955, 5628.690422026787, 5633.40849210831, 5634.6337488063145, 5643.746031428595, 21791.67312490314, 22054.228102016514, 22300.107995680155, 22531.662025069636, 22692.65961010586, 2187.3437968609514, 2199.373178644095, 2219.04581030157, 2262.7058482397347, 2320.3271051395077, 9459.574319155585, 9876.901230987742, 9981.251406144569, 10362.481875906175, 10500.107490863209, 1870.485616455472, 1870.8596855235776, 1873.6721073812027, 1876.3714155757837, 1910.2931915191468, 76261.61869190619, 80929.0, 81021.59489202517, 81681.0, 82201.0, 10203.693889183336, 10225.181985441146, 10257.384556926609, 10419.280818664836, 10428.634997775041, 14279.214643194517, 14284.642883927985, 14328.785068223984, 14333.354999025069, 14404.207768572829, 7112.679929403189, 7349.154847192534, 7353.227911069368, 7377.704891804267, 7476.25237476248, 6932.064171336906, 6977.267386924402, 7000.0, 7165.605891676008, 7174.354308112295, 4162.708610397303, 4334.41485399467, 4335.609795118391, 4341.804618792099, 4464.352668862996, 1778.2207824570146, 1779.590694140355, 1791.6506281275288, 1804.7112462006016, 1827.5887925216987, 898.492351821232, 902.5893218585528, 927.8747369105084, 945.163530275711, 981.9558119884622, 18275.177617007266, 19277.90361048186, 19606.313779017666, 19613.0, 19885.204591816455, 906.551257127726, 949.349695458613, 960.7790208252142, 966.9129778319985, 1006.3408467453829, 10285.897141028643, 10391.0, 10788.784224315626, 10870.510827012804, 10871.891281087246, 417990.0, 419976.0, 438879.0, 440724.0, 440993.0, 93222.53388733012, 93773.5311323439, 94069.0, 94857.52571237237, 95302.52348738212, 996.4121168510613, 1038.6105210546045, 1050.8844027156854, 1051.2168434516182, 1059.920505962056, 16544.255508501905, 16670.833291666928, 16713.832861671715, 17134.485965420557, 18006.72989905179, 42106.789466052476, 42125.789371054176, 42586.361204581335, 42735.7863210682, 43083.707488775384, 57617.0, 58171.41828581829, 59448.70275648594, 59518.40481595302, 59880.0, 8079.636416361161, 8237.79405514843, 8392.16078392156, 8635.222829945335, 8823.955880220557, 10121.949390253001, 12909.354532273537, 13286.734265314833, 13342.332883355988, 13390.464381424634, 11147.498362573542, 11323.773524529628, 11498.0, 11646.534138634359, 11940.820887686865, 11217.775644486901, 11259.662210133709, 11464.541418343506, 11622.535098595961, 11826.940865295619, 11750.0, 11898.583549575724, 11959.282443053444, 11976.0, 11976.640700778991, 8273.46222495536, 8336.166383361859, 8351.29014033814, 8435.325173985944, 8623.56882155877, 9937.0, 11312.6040588579, 11657.941710291394, 12114.454849531969, 12212.694682633006], "value": 8965.896384604743, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1335.812986181934, 1455.8107446032013, 1479.1199236454308, 1600.631854673425, 1743.7820272465933, 7417.554946703195, 8536.274416674582, 8833.602487888045, 8841.557922103884, 8859.645614175426, 8640.265577425926, 8679.175478329564, 8693.217610415062, 8695.69565065223, 8713.73858784236, 2230.4795580993537, 2234.553089382122, 2256.007356763027, 2256.582532231534, 2263.524659821431, 2159.924402645908, 2191.441182498461, 2275.2946586558137, 2285.211601997308, 2292.7821856923565, 2231.4309850988056, 2239.070785623964, 2246.865188088712, 2247.2471721973156, 2265.2977576951116, 2162.740471143457, 2183.2467798609455, 2186.202036256771, 2188.682641017044, 2190.4304880730965, 2142.475093602062, 2144.5925274197853, 2149.0, 2152.4726442021647, 2155.633542297813, 8516.361272904556, 8579.914200857975, 8630.439021463584, 8656.394052416334, 8656.740297791077, 5009.4239162496415, 5221.138512145491, 5222.817201397933, 5231.738413079331, 5271.446498117719, 3178.253110519026, 3364.764466487347, 3401.897943061712, 3437.9828100859336, 3440.827958602085, 973.6154219083493, 1029.5109822834095, 1032.633415137623, 1047.8952104789537, 1076.5263284154946, 11648.94175529117, 11737.237079589799, 11758.000569951564, 11785.116116291227, 11852.051835853024, 4188.748675079505, 4236.406903033578, 4283.421738065384, 4449.466064072332, 4465.307877279027, 9531.285153613368, 9562.378445401027, 9562.426254424758, 9575.377600456088, 9587.328886977984, 4911.582515486152, 4921.990991846663, 4958.1323268428605, 4987.077390682735, 4996.475370086088, 3748.887533374003, 4010.3783913493453, 4132.0, 4640.141573808856, 4640.559146881108, 3310.9172270693425, 3587.6232995535615, 3644.3075815594952, 3658.908527286839, 3678.6137455567314, 1067.9519421626046, 1102.1238115698038, 1106.6071544601712, 1110.3559935237543, 1111.5164903267105, 780.9140994490601, 874.8906386701663, 903.1104362203224, 910.3536489092818, 939.0515579264855, 5642.71786410686, 5738.225339579187, 5747.770089196469, 5755.0, 6047.03247480401, 929.7582628516634, 939.3143005605946, 939.4504215034282, 950.396498223633, 958.3866325551653, 3902.2585708715255, 3926.5680775114715, 3946.2304850553865, 3983.462232598562, 4004.0990777074926, 10458.895411045944, 10814.837777433344, 10821.9458902705, 10824.56701731922, 10841.83737243942, 10638.882917293728, 10744.462776861126, 10753.301035432673, 10757.623483178051, 10771.6229931952, 7884.842303153905, 7888.881666775003, 7907.960460197777, 7917.445778795429, 8005.679772809139, 5576.553875690016, 5620.522255608155, 5755.71221438918, 5763.164341170591, 5782.190493330853, 9366.157045865904, 9701.805963880824, 9722.854157187789, 9832.60669573209, 9972.800543989224, 8870.15733505316, 9881.456519891475, 10096.545655445376, 10097.949510252402, 10194.388336699822, 6600.372964568358, 6836.145481814773, 6915.585064896122, 6974.511784175059, 7180.60506672138, 8248.010238771385, 8255.25702686761, 8332.6666933322, 8388.286995605198, 8392.66429342844, 7482.625868706652, 7586.165521792709, 7659.310662040443, 7670.8849367260655, 7830.2169783021245, 7152.9284707152265, 7260.346568808833, 7302.671379788028, 7534.35957943559, 7564.848703025798, 6625.50308726857, 6925.549839260432, 7035.929640703732, 7051.224365319913, 7057.752978645723, 4757.0, 4844.394450693663, 4946.134426475424, 5035.446100928968, 5223.973880130575, 5039.823606173766, 5058.494150585059, 5095.643304968617, 5109.208072748581, 5186.196139598368], "value": 4438.736111331089, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [308.82088388734553, 314.4936651990296, 321.60121449402743, 325.2373184881452, 327.92293810954436, 5109.080365534202, 5251.212318152279, 5311.73441327934, 5330.640686624915, 5334.466553344663, 5044.772985215665, 5114.411842638097, 5138.254953031808, 5160.329157209558, 5177.818776342829, 4079.3880917862334, 4097.364908439196, 4098.344264917614, 4107.507099148106, 4115.732477388975, 3992.2215168042244, 4106.876793696194, 4120.629143377096, 4128.069070959622, 4134.441850350209, 4033.919321613566, 4046.089629833293, 4054.8378064877515, 4060.9187816243657, 4064.2887494688457, 4035.3139966205667, 4040.8585699500377, 4042.858499952517, 4045.4538637284177, 4050.7569545827346, 3449.862005519776, 3562.750607457479, 3566.3402270580027, 3570.982145089284, 3584.6594573515476, 5071.275766239496, 5115.386153661547, 5119.923201151985, 5125.359330083739, 5133.279361938179, 4626.653001024936, 4633.7683115844075, 4640.69835460694, 4644.419447569054, 4666.39336886206, 5281.63028587999, 5423.430539793304, 5433.103537916279, 5474.808381706661, 5487.5609951203805, 3910.061585219555, 3915.158240978203, 3915.6280153385383, 3921.5882332354977, 3935.5670876203594, 5666.769941133555, 5670.404607516234, 5690.573207009449, 5694.544436445116, 5704.286964129484, 3813.1801662642665, 3984.960150398517, 3987.980060099739, 3993.880183594497, 4005.516579720592, 4062.435962154592, 4064.9796751016056, 4065.6137666921595, 4067.430559721641, 4073.8777836664353, 4646.814127434933, 4651.534846515389, 4654.417498050679, 4657.068586282757, 4666.346711460398, 5256.658317209369, 5538.344692503009, 5543.0344765550235, 5549.417311182348, 5563.276774019432, 1314.6187605594462, 1338.8393392792732, 1346.3066520741825, 1377.8759911608004, 1384.1279993603964, 931.1991687149047, 932.1424289653535, 951.110711484764, 962.4081190068058, 964.320154291223, 5269.341332333458, 5277.445868183862, 5284.524392804666, 5303.549198318186, 5306.522412982773, 5582.385937546866, 5598.872428477152, 5605.8037968671715, 5616.213730077792, 5626.803061892814, 5147.716875571805, 5279.498447647467, 5306.310179676694, 5311.521963023347, 5397.70312632809, 2991.2073300575366, 3018.9245268868453, 3019.39612077581, 3019.426309001283, 3025.667176610571, 5861.531077513789, 5864.2083318752275, 5866.589338746332, 5892.467958330779, 5928.703564821828, 5592.664440133605, 5710.65736055838, 5764.538836893039, 5779.248697669276, 5797.420257974169, 5799.3620701722775, 5806.970965145148, 5835.67903765297, 5851.473367396955, 5876.383994401574, 5485.573750824894, 5666.405027472056, 5698.458646428583, 5701.173329867229, 5715.514181294637, 5620.206360706425, 5652.463016013472, 5658.151277308437, 5676.517496012885, 5686.601937864475, 5825.621334613236, 5891.646501209942, 5894.616849904914, 5895.7052147391605, 5907.970460147843, 3924.3917192835156, 3995.600439955981, 4027.7180597357906, 4034.6772258219858, 4049.1294371710223, 5426.728663566727, 5705.258316418839, 5709.173958890376, 5720.74256658443, 5721.22763426932, 5427.457254274541, 5473.698946557977, 5572.582056345871, 5576.609637325349, 5596.384397716167, 5544.805931792368, 5553.888922221614, 5558.887622703347, 5579.302587176603, 5583.525400341016, 5306.487651019441, 5482.451754824486, 5499.50504454601, 5509.146082357241, 5524.48076778889, 5509.393966663583, 5591.120572905039, 5624.521915637217, 5624.750099959885, 5628.155776633538, 5488.890222195613, 5496.230527726041, 5514.91727624094, 5523.309586301712, 5534.201384550118], "value": 4195.260315891675, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [642.575899906062, 754.830163213277, 763.446501286567, 770.1143684762526, 774.8792652996592, 14375.353109110089, 15175.84824151761, 16596.50210493684, 16695.666086678273, 16760.32958681651, 12754.170978886366, 12915.741685166291, 12916.354182290896, 12928.353582320893, 12935.159214651041, 795.7413840501846, 817.2889586060106, 817.5299202958294, 818.7257268814955, 818.8075802186481, 681.935216154467, 694.0630149298457, 793.4049462902823, 816.391788117853, 820.0405525535139, 861.6725644255174, 862.7023676831483, 863.9395242333007, 864.7838040489878, 865.0138841720444, 854.7393045121236, 855.0850589868843, 855.102142750113, 855.1320409784074, 855.4012191465968, 508.5194491205812, 519.4908989190615, 609.4545381883235, 622.1445512420422, 623.2769986815273, 12912.54806081792, 12995.935020324932, 13038.15252008626, 13117.278549679764, 13124.278164700938, 13725.45098196071, 14171.64570885736, 14328.211948342838, 14439.566812995627, 14480.71038579233, 12787.232766034067, 12974.221546707227, 13073.411696473682, 13233.801492977613, 13279.668008299774, 4364.432623758923, 4376.343548467756, 4428.092241090569, 4469.888252793674, 4619.976900115512, 75272.0, 77058.6147069261, 77242.61378693127, 77429.61285193538, 79818.6009069951, 10884.673459796219, 10989.560417583367, 11167.106631469464, 11194.328340299608, 11433.656990290305, 19184.328548500736, 19220.615587688448, 19235.65350425457, 19361.612767744566, 19388.12753426099, 8007.7998050048045, 8044.597770111471, 8106.918930810734, 8208.794780130545, 8250.092489826115, 4267.594578515098, 4285.1643929434085, 4373.2128216921255, 4417.425734654538, 4421.889452763642, 3332.6334103248623, 3416.299658569987, 3419.4357930941615, 3419.452887537982, 3455.9654403456148, 532.0901258847337, 545.0, 547.3814589513903, 548.7585462396612, 565.4882331490008, 466.4985140973467, 549.4779959038929, 575.7524264566276, 588.8910551547978, 591.6480841277746, 7831.882521762178, 7921.287084162338, 8038.919610803817, 8195.836083278302, 8317.168283171755, 554.9167624856303, 601.8946684330225, 602.4246844263718, 606.5178183344252, 608.0726891490424, 3911.647951684362, 4016.7991600419864, 4137.97931010349, 4139.2963196256105, 4169.395437661522, 113899.43050284861, 114117.4294128524, 114257.0, 114469.71060578742, 116563.0, 94959.52520237355, 96903.5774105653, 101218.0, 101549.0, 103080.0, 63700.0, 83474.58262708769, 84953.15046849576, 87305.69041464383, 87841.0, 7386.96306518464, 7587.089549254125, 7648.617569121633, 7684.385249179941, 7870.29167374939, 51140.23289650584, 51141.073133664344, 51650.74174629103, 52027.21959170691, 53008.20487692611, 61927.0, 63605.36394635995, 73121.0, 76321.23678763364, 77374.61312693401, 12168.391580421121, 12415.93792031034, 12433.93783031079, 12536.310502922426, 13252.138610990254, 12786.168899021533, 13048.151870128411, 13273.867261327649, 13575.782930910656, 13854.376553054935, 12009.279443233434, 12098.153129281218, 12247.121455986133, 12413.627591172279, 12709.364531773559, 12842.807357889453, 12879.420426081037, 13057.542985995444, 13061.08572399923, 13310.86689133135, 11549.841143765094, 11655.825162622397, 11792.469338879599, 11944.64166075019, 12191.207571507824, 10015.949920250352, 10404.271700980858, 10712.625058122929, 10764.25511494564, 10863.67408977732, 9679.0, 10464.215183861088, 10633.308834925705, 10697.197710171924, 10717.35695858251], "value": 7112.0853596201605, "unit": "score"}], "name": "dromaeo_css", "value": 6983.019157223916, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 112.0, 113.0, 111.0, 112.0, 112.0, 111.0, 111.0, 109.0, 110.0], "value": 110.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 123.0, 124.0, 169.0, 123.0, 128.0, 122.0, 124.0, 160.0, 125.0], "value": 134.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 161.0, 160.0, 160.0, 162.0, 162.0, 163.0, 161.0, 162.0], "value": 161.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 77.0, 112.0, 78.0, 76.0, 76.0, 75.0, 100.0, 76.0], "value": 82.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 129.0, 84.0, 84.0, 83.0, 113.0, 82.0, 82.0, 114.0], "value": 93.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 118.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0], "value": 117.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 145.0, 146.0, 145.0, 145.0, 146.0, 145.0, 145.0, 145.0], "value": 145.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 85.0, 85.0, 85.0, 84.0, 85.0, 84.0, 85.0, 85.0], "value": 84.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 52.0, 52.0, 52.0, 53.0, 55.0, 54.0, 53.0, 55.0, 53.0], "value": 53.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 61.0, 60.0, 61.0, 60.0, 60.0, 60.0, 59.0, 60.0, 61.0], "value": 60.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 80.0, 81.0, 80.0, 82.0, 81.0, 79.0, 79.0, 83.0, 80.0], "value": 81.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [130.0, 130.0, 131.0, 130.0, 136.0, 135.0, 136.0, 134.0, 172.0, 137.0], "value": 137.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 164.0, 163.0, 169.0, 165.0, 166.0, 169.0, 164.0, 169.0, 167.0], "value": 166.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 67.0, 66.0, 66.0, 65.0, 67.0, 65.0, 67.0, 68.0, 64.0], "value": 66.2, "unit": "score"}], "name": "kraken", "value": 1493.3, "alertThreshold": 2.0}]} 18:58:41 INFO - Return code: 0 18:58:41 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 18:58:41 INFO - # TBPL SUCCESS # 18:58:41 INFO - Running post-action listener: _resource_record_post_action 18:58:41 INFO - [mozharness: 2016-10-18 01:58:41.587005Z] Finished run-tests step (success) 18:58:41 INFO - Running post-run listener: _resource_record_post_run 18:58:41 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 0; Write bytes: 403775488; Read time: 0; Write time: 289312 18:58:41 INFO - TinderboxPrint: CPU usage
13.0% 18:58:41 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 18:58:41 INFO - TinderboxPrint: I/O write bytes / time
403,775,488 / 289,312 18:58:41 INFO - TinderboxPrint: CPU idle
8,297.8 (87.0%) 18:58:41 INFO - TinderboxPrint: CPU user
1,196.8 (12.5%) 18:58:41 INFO - TinderboxPrint: Swap in / out
0 / 0 18:58:41 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 114528256; Read time: 0; Write time: 105044 18:58:41 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 0; Write bytes: 288309248; Read time: 0; Write time: 184264 18:58:42 INFO - Running post-run listener: _upload_blobber_files 18:58:42 INFO - Blob upload gear active. 18:58:42 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:58:42 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 18:58:42 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', 'Autoland', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 18:58:42 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 Autoland -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 18:58:42 INFO - (blobuploader) - INFO - Open directory for files ... 18:58:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 18:58:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:58:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:58:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 18:58:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:58:44 INFO - (blobuploader) - INFO - Done attempting. 18:58:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 18:58:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:58:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:58:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 18:58:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:58:45 INFO - (blobuploader) - INFO - Done attempting. 18:58:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 18:58:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:58:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:58:49 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 18:58:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:58:49 INFO - (blobuploader) - INFO - Done attempting. 18:58:49 INFO - (blobuploader) - INFO - Iteration through files over. 18:58:49 INFO - Return code: 0 18:58:49 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:58:49 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:58:49 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/3a7cef54705f32963aaf9e49349022938bc524b65d9d837b1bb91f89eaf5919834952cf32801aaf483bac686be412216e246001fce4af7b3d6fa162e68448927", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d576366b4ddf93e2372089b3dc5b0b2899910c6149e3b655671e71813cdce5e5a2fe8edf2d24bdec7b7bf1acff51c933c9a14871aa3fabf4ce33daa22a1bf153", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/070d67e01494e53ea45ea294d721b1e0921022d77c75f1d2ca56616af4f9f428973c4b5c85114d8f526abad805395f1e0eecfbdd17b035e5df811f1c15a3bc96"} 18:58:49 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:58:49 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:58:49 INFO - Contents: 18:58:49 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/3a7cef54705f32963aaf9e49349022938bc524b65d9d837b1bb91f89eaf5919834952cf32801aaf483bac686be412216e246001fce4af7b3d6fa162e68448927", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d576366b4ddf93e2372089b3dc5b0b2899910c6149e3b655671e71813cdce5e5a2fe8edf2d24bdec7b7bf1acff51c933c9a14871aa3fabf4ce33daa22a1bf153", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/070d67e01494e53ea45ea294d721b1e0921022d77c75f1d2ca56616af4f9f428973c4b5c85114d8f526abad805395f1e0eecfbdd17b035e5df811f1c15a3bc96"} 18:58:49 INFO - Running post-run listener: copy_logs_to_upload_dir 18:58:49 INFO - Copying logs to upload dir... 18:58:49 INFO - mkdir: /builds/slave/test/build/upload/logs 18:58:49 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.385493 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-10-17 18:58:48.551098) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-17 18:58:48.555222) ========= 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=0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/3a7cef54705f32963aaf9e49349022938bc524b65d9d837b1bb91f89eaf5919834952cf32801aaf483bac686be412216e246001fce4af7b3d6fa162e68448927", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d576366b4ddf93e2372089b3dc5b0b2899910c6149e3b655671e71813cdce5e5a2fe8edf2d24bdec7b7bf1acff51c933c9a14871aa3fabf4ce33daa22a1bf153", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/070d67e01494e53ea45ea294d721b1e0921022d77c75f1d2ca56616af4f9f428973c4b5c85114d8f526abad805395f1e0eecfbdd17b035e5df811f1c15a3bc96"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011207 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476732605/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/3a7cef54705f32963aaf9e49349022938bc524b65d9d837b1bb91f89eaf5919834952cf32801aaf483bac686be412216e246001fce4af7b3d6fa162e68448927", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/d576366b4ddf93e2372089b3dc5b0b2899910c6149e3b655671e71813cdce5e5a2fe8edf2d24bdec7b7bf1acff51c933c9a14871aa3fabf4ce33daa22a1bf153", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/070d67e01494e53ea45ea294d721b1e0921022d77c75f1d2ca56616af4f9f428973c4b5c85114d8f526abad805395f1e0eecfbdd17b035e5df811f1c15a3bc96"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-17 18:58:48.580762) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 18:58:48.581101) ========= 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=0333a256a5e4f052382dd180000001b1-1476754688.844045-962078934 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004439 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-17 18:58:48.663613) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-17 18:58:48.663958) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-17 18:58:48.664263) ========= ========= Total master_lag: 0.17 =========