builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-045 starttime: 1476866384.1 results: success (0) buildid: 20161019005522 builduid: b31b799c82734d8e8b6631cf74a5c3e9 revision: e4282badddda00fb555bd2e5300c92149434a884 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.099811) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.100310) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.100590) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.115071) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.115347) ========= 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=4300f881736b422476174874000001bc-1476866383.846336-1371870119 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-19 01:39:44-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.8M=0s 2016-10-19 01:39:44 (46.8 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.120074 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.249043) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.249381) ========= 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=4300f881736b422476174874000001bc-1476866383.846336-1371870119 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015825 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.300209) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:44.300563) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev e4282badddda00fb555bd2e5300c92149434a884 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev e4282badddda00fb555bd2e5300c92149434a884 --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=4300f881736b422476174874000001bc-1476866383.846336-1371870119 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-19 01:39:44,758 truncating revision to first 12 chars 2016-10-19 01:39:44,758 Setting DEBUG logging. 2016-10-19 01:39:44,758 attempt 1/10 2016-10-19 01:39:44,759 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/e4282badddda?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-19 01:39:45,257 unpacking tar archive at: fx-team-e4282badddda/testing/mozharness/ program finished with exit code 0 elapsedTime=0.806342 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:45.119990) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:45.120367) ========= script_repo_revision: e4282badddda00fb555bd2e5300c92149434a884 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:45.120824) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:45.121130) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-19 01:39:45.130508) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-10-19 01:39:45.130817) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1476866383.846336-1371870119 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 01:39:45 INFO - MultiFileLogger online at 20161019 01:39:45 in /builds/slave/test 01:39:45 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 01:39:45 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 01:39:45 INFO - {'append_to_log': False, 01:39:45 INFO - 'base_work_dir': '/builds/slave/test', 01:39:45 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 01:39:45 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 01:39:45 INFO - 'branch': 'Fx-Team-Non-PGO', 01:39:45 INFO - 'buildbot_json_path': 'buildprops.json', 01:39:45 INFO - 'config_files': ('talos/linux_config.py',), 01:39:45 INFO - 'default_actions': ('clobber', 01:39:45 INFO - 'read-buildbot-config', 01:39:45 INFO - 'download-and-extract', 01:39:45 INFO - 'populate-webroot', 01:39:45 INFO - 'create-virtualenv', 01:39:45 INFO - 'install', 01:39:45 INFO - 'run-tests'), 01:39:45 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 01:39:45 INFO - 'download_minidump_stackwalk': True, 01:39:45 INFO - 'download_symbols': 'ondemand', 01:39:45 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 01:39:45 INFO - 'tooltool.py': '/tools/tooltool.py', 01:39:45 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 01:39:45 INFO - '/tools/misc-python/virtualenv.py')}, 01:39:45 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 01:39:45 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 01:39:45 INFO - 'installer_path': 'installer.exe', 01:39:45 INFO - 'log_level': 'info', 01:39:45 INFO - 'log_name': 'talos', 01:39:45 INFO - 'log_to_console': True, 01:39:45 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 01:39:45 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 01:39:45 INFO - 'opt_config_files': (), 01:39:45 INFO - 'pip_index': False, 01:39:45 INFO - 'sps_profile': False, 01:39:45 INFO - 'sps_profile_interval': 0, 01:39:45 INFO - 'suite': 'dromaeojs', 01:39:45 INFO - 'system_bits': '32', 01:39:45 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 01:39:45 INFO - 'title': 'talos-linux64-ix-045', 01:39:45 INFO - 'tooltool_cache': '/builds/tooltool_cache', 01:39:45 INFO - 'use_talos_json': True, 01:39:45 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 01:39:45 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 01:39:45 INFO - 'work_dir': 'build'} 01:39:45 INFO - [mozharness: 2016-10-19 08:39:45.688688Z] Running clobber step. 01:39:45 INFO - Running pre-action listener: _resource_record_pre_action 01:39:45 INFO - Running main action method: clobber 01:39:45 INFO - rmtree: /builds/slave/test/build 01:39:45 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 01:39:46 INFO - Running post-action listener: _resource_record_post_action 01:39:46 INFO - [mozharness: 2016-10-19 08:39:46.169679Z] Finished clobber step (success) 01:39:46 INFO - [mozharness: 2016-10-19 08:39:46.169779Z] Running read-buildbot-config step. 01:39:46 INFO - Running pre-action listener: _resource_record_pre_action 01:39:46 INFO - Running main action method: read_buildbot_config 01:39:46 INFO - Using buildbot properties: 01:39:46 INFO - { 01:39:46 INFO - "project": "", 01:39:46 INFO - "product": "firefox", 01:39:46 INFO - "script_repo_revision": "production", 01:39:46 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 01:39:46 INFO - "repository": "", 01:39:46 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 01:39:46 INFO - "buildid": "20161019005522", 01:39:46 INFO - "pgo_build": "False", 01:39:46 INFO - "basedir": "/builds/slave/test", 01:39:46 INFO - "buildnumber": 2207, 01:39:46 INFO - "slavename": "talos-linux64-ix-045", 01:39:46 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 01:39:46 INFO - "platform": "ubuntu64_hw", 01:39:46 INFO - "scheduler": "tests-fx-team-linux64-talos", 01:39:46 INFO - "branch": "fx-team", 01:39:46 INFO - "repo_path": "integration/fx-team", 01:39:46 INFO - "revision": "e4282badddda00fb555bd2e5300c92149434a884", 01:39:46 INFO - "stage_platform": "linux64", 01:39:46 INFO - "builduid": "b31b799c82734d8e8b6631cf74a5c3e9", 01:39:46 INFO - "slavebuilddir": "test" 01:39:46 INFO - } 01:39:46 INFO - Found installer url https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 01:39:46 INFO - Running post-action listener: _resource_record_post_action 01:39:46 INFO - [mozharness: 2016-10-19 08:39:46.172189Z] Finished read-buildbot-config step (success) 01:39:46 INFO - [mozharness: 2016-10-19 08:39:46.172276Z] Running download-and-extract step. 01:39:46 INFO - Running pre-action listener: _resource_record_pre_action 01:39:46 INFO - Running main action method: download_and_extract 01:39:46 INFO - mkdir: /builds/slave/test/build/tests 01:39:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:39:46 INFO - trying https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 01:39:46 INFO - Downloading https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 01:39:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 01:39:46 INFO - Downloaded 1361 bytes. 01:39:46 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 01:39:46 INFO - Using the following test package requirements: 01:39:46 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 01:39:46 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 01:39:46 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 01:39:46 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'jsshell-linux-x86_64.zip'], 01:39:46 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 01:39:46 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 01:39:46 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 01:39:46 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 01:39:46 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 01:39:46 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 01:39:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 01:39:46 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 01:39:46 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 01:39:46 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:39:46 INFO - Fetch https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 01:39:47 INFO - Http code: 200 01:39:47 INFO - via: 1.1 73fa5a1ee49cf827e596b502b5927eab.cloudfront.net (CloudFront) 01:39:47 INFO - x-amz-cf-id: OwbCyOZDWLBP5wDwBYXzadmciFBWIfOfFvKY-x4eewt0PrT1kSZaBw== 01:39:47 INFO - x-amz-version-id: Psvt_kSHW3YnL6upaU91kHYZa3l3iHym 01:39:47 INFO - Expected file size: 20542178 01:39:47 INFO - Obtained file size: 20542178 01:39:51 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 01:39:51 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 01:39:51 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:39:51 INFO - Fetch https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 01:39:52 INFO - Http code: 200 01:39:52 INFO - via: 1.1 ccaa055c9a26ce13da709353563e04a5.cloudfront.net (CloudFront) 01:39:52 INFO - x-amz-cf-id: hNNdohoO0JybTXl97GVRCRDEHrNj93hQ2SJ-wqUMZgxSrvIPYK_Zmg== 01:39:52 INFO - x-amz-version-id: Psvt_kSHW3YnL6upaU91kHYZa3l3iHym 01:39:52 INFO - Expected file size: 20542178 01:39:52 INFO - Obtained file size: 20542178 01:39:56 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 01:39:56 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 01:39:56 INFO - Fetch https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 01:39:57 INFO - Http code: 200 01:39:57 INFO - via: 1.1 9baadab4e4d95afe7af7bcba342b29c6.cloudfront.net (CloudFront) 01:39:57 INFO - x-amz-cf-id: JKlqxDHFXqtyP1qoP41qNh4T4sB3i6sAJjfqGjjv34JmCrOA0tQf6A== 01:39:57 INFO - x-amz-version-id: RJgOlu7BBrhABLZi7FyfGqZMD_rDirJp 01:39:57 INFO - Expected file size: 14409028 01:39:57 INFO - Obtained file size: 14409028 01:39:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:39:57 INFO - trying https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 01:39:57 INFO - Downloading https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 01:39:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 01:39:59 INFO - Downloaded 55595308 bytes. 01:39:59 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 01:39:59 INFO - mkdir: /builds/slave/test/properties 01:39:59 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 01:39:59 INFO - Writing to file /builds/slave/test/properties/build_url 01:39:59 INFO - Contents: 01:39:59 INFO - build_url:https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 01:39:59 INFO - Running post-action listener: _resource_record_post_action 01:39:59 INFO - Running post-action listener: set_extra_try_arguments 01:39:59 INFO - [mozharness: 2016-10-19 08:39:59.710556Z] Finished download-and-extract step (success) 01:39:59 INFO - [mozharness: 2016-10-19 08:39:59.710781Z] Running populate-webroot step. 01:39:59 INFO - Running pre-action listener: _resource_record_pre_action 01:39:59 INFO - Running main action method: populate_webroot 01:39:59 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 01:39:59 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 01:39:59 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 01:39:59 INFO - '--tppagecycles', 01:39:59 INFO - '7'], 01:39:59 INFO - 'tests': ['tsvgm']}}, 01:39:59 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['tresize', 'tcanvasmark']}, 01:39:59 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 01:39:59 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['dromaeo_css', 'kraken']}, 01:39:59 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 01:39:59 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:39:59 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:39:59 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['damp', 'tps']}, 01:39:59 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'tests': ['damp', 'tps']}, 01:39:59 INFO - 'g3': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['dromaeo_dom']}, 01:39:59 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 01:39:59 INFO - 'g4': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['basic_compositor_video']}, 01:39:59 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 01:39:59 INFO - 'other': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['a11yr', 01:39:59 INFO - 'ts_paint', 01:39:59 INFO - 'tpaint', 01:39:59 INFO - 'sessionrestore', 01:39:59 INFO - 'sessionrestore_no_auto_restore', 01:39:59 INFO - 'tabpaint']}, 01:39:59 INFO - 'other-e10s': {'tests': ['a11yr', 01:39:59 INFO - 'ts_paint', 01:39:59 INFO - 'tpaint', 01:39:59 INFO - 'sessionrestore', 01:39:59 INFO - 'sessionrestore_no_auto_restore', 01:39:59 INFO - 'tabpaint']}, 01:39:59 INFO - 'other-e10s_l64': {'tests': ['a11yr', 01:39:59 INFO - 'ts_paint', 01:39:59 INFO - 'tpaint', 01:39:59 INFO - 'sessionrestore', 01:39:59 INFO - 'sessionrestore_no_auto_restore', 01:39:59 INFO - 'tabpaint']}, 01:39:59 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 01:39:59 INFO - 'ts_paint', 01:39:59 INFO - 'tpaint', 01:39:59 INFO - 'sessionrestore', 01:39:59 INFO - 'sessionrestore_no_auto_restore', 01:39:59 INFO - 'tabpaint']}, 01:39:59 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['a11yr', 01:39:59 INFO - 'ts_paint', 01:39:59 INFO - 'tpaint', 01:39:59 INFO - 'sessionrestore', 01:39:59 INFO - 'sessionrestore_no_auto_restore', 01:39:59 INFO - 'tabpaint']}, 01:39:59 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['a11yr', 01:39:59 INFO - 'ts_paint', 01:39:59 INFO - 'tpaint', 01:39:59 INFO - 'sessionrestore', 01:39:59 INFO - 'sessionrestore_no_auto_restore', 01:39:59 INFO - 'tabpaint']}, 01:39:59 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['tsvgx', 01:39:59 INFO - 'tsvgr_opacity', 01:39:59 INFO - 'tart', 01:39:59 INFO - 'tscrollx', 01:39:59 INFO - 'cart']}, 01:39:59 INFO - 'svgr-e10s': {'tests': ['tsvgx', 01:39:59 INFO - 'tsvgr_opacity', 01:39:59 INFO - 'tart', 01:39:59 INFO - 'tscrollx', 01:39:59 INFO - 'cart']}, 01:39:59 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'talos_options': ['--disable-e10s'], 01:39:59 INFO - 'tests': ['tp5o']}, 01:39:59 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'tests': ['tp5o']}, 01:39:59 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'talos_options': ['--disable-e10s', 01:39:59 INFO - '--xperf_path', 01:39:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:39:59 INFO - 'tests': ['tp5n']}, 01:39:59 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:39:59 INFO - 'talos_options': ['--xperf_path', 01:39:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:39:59 INFO - 'tests': ['tp5n']}}, 01:39:59 INFO - 'talos.zip': {'path': '', 01:39:59 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 01:39:59 INFO - Running post-action listener: _resource_record_post_action 01:39:59 INFO - [mozharness: 2016-10-19 08:39:59.733196Z] Finished populate-webroot step (success) 01:39:59 INFO - [mozharness: 2016-10-19 08:39:59.733283Z] Running create-virtualenv step. 01:39:59 INFO - Running pre-action listener: _resource_record_pre_action 01:39:59 INFO - Running main action method: create_virtualenv 01:39:59 INFO - Creating virtualenv /builds/slave/test/build/venv 01:39:59 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 01:39:59 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 01:39:59 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 01:39:59 INFO - Using real prefix '/usr' 01:39:59 INFO - New python executable in /builds/slave/test/build/venv/bin/python 01:40:00 INFO - Installing distribute.............................................................................................................................................................................................done. 01:40:02 INFO - Installing pip.................done. 01:40:02 INFO - Return code: 0 01:40:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 01:40:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 01:40:02 INFO - Reading from file tmpfile_stdout 01:40:02 INFO - Output received: 01:40:02 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) 01:40:02 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 01:40: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')]} 01:40:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40: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')]} 01:40:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:02 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:02 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 01:40:02 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 01:40:02 INFO - Using env: {'DISPLAY': ':0', 01:40:02 INFO - 'HOME': '/home/cltbld', 01:40:02 INFO - 'LANG': 'en_US.UTF-8', 01:40:02 INFO - 'LANGUAGE': 'en_US:en', 01:40:02 INFO - 'LOGNAME': 'cltbld', 01:40:02 INFO - 'MAIL': '/var/mail/cltbld', 01:40:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:02 INFO - 'MOZ_NO_REMOTE': '1', 01:40:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:02 INFO - 'NO_EM_RESTART': '1', 01:40:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:02 INFO - 'PWD': '/builds/slave/test', 01:40:02 INFO - 'SHELL': '/bin/bash', 01:40:02 INFO - 'SHLVL': '1', 01:40:02 INFO - 'TERM': 'linux', 01:40:02 INFO - 'TMOUT': '86400', 01:40:02 INFO - 'USER': 'cltbld', 01:40:02 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:02 INFO - '_': '/tools/buildbot/bin/python'} 01:40:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:02 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 01:40:02 INFO - Cleaning up... 01:40:02 INFO - Return code: 0 01:40:02 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 01:40: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')]} 01:40:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40: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')]} 01:40:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:02 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:02 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 01:40:02 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 01:40:02 INFO - Using env: {'DISPLAY': ':0', 01:40:02 INFO - 'HOME': '/home/cltbld', 01:40:02 INFO - 'LANG': 'en_US.UTF-8', 01:40:02 INFO - 'LANGUAGE': 'en_US:en', 01:40:02 INFO - 'LOGNAME': 'cltbld', 01:40:02 INFO - 'MAIL': '/var/mail/cltbld', 01:40:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:02 INFO - 'MOZ_NO_REMOTE': '1', 01:40:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:02 INFO - 'NO_EM_RESTART': '1', 01:40:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:02 INFO - 'PWD': '/builds/slave/test', 01:40:02 INFO - 'SHELL': '/bin/bash', 01:40:02 INFO - 'SHLVL': '1', 01:40:02 INFO - 'TERM': 'linux', 01:40:02 INFO - 'TMOUT': '86400', 01:40:02 INFO - 'USER': 'cltbld', 01:40:02 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:02 INFO - '_': '/tools/buildbot/bin/python'} 01:40:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:02 INFO - Downloading/unpacking psutil>=3.1.1 01:40:02 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 01:40:02 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 01:40:02 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 01:40:02 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 01:40:02 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 01:40:02 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 01:40:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 01:40:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:40:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:40:05 INFO - Installing collected packages: psutil 01:40:05 INFO - Running setup.py install for psutil 01:40:05 INFO - building 'psutil._psutil_linux' extension 01:40:05 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 01:40:05 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 01:40:05 INFO - building 'psutil._psutil_posix' extension 01:40:05 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 01:40:05 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 01:40:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:40:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:40:05 INFO - Successfully installed psutil 01:40:05 INFO - Cleaning up... 01:40:05 INFO - Return code: 0 01:40:05 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 01:40:05 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')]} 01:40:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:05 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')]} 01:40:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:05 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:05 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 01:40:05 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 01:40:05 INFO - Using env: {'DISPLAY': ':0', 01:40:05 INFO - 'HOME': '/home/cltbld', 01:40:05 INFO - 'LANG': 'en_US.UTF-8', 01:40:05 INFO - 'LANGUAGE': 'en_US:en', 01:40:05 INFO - 'LOGNAME': 'cltbld', 01:40:05 INFO - 'MAIL': '/var/mail/cltbld', 01:40:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:05 INFO - 'MOZ_NO_REMOTE': '1', 01:40:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:05 INFO - 'NO_EM_RESTART': '1', 01:40:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:05 INFO - 'PWD': '/builds/slave/test', 01:40:05 INFO - 'SHELL': '/bin/bash', 01:40:05 INFO - 'SHLVL': '1', 01:40:05 INFO - 'TERM': 'linux', 01:40:05 INFO - 'TMOUT': '86400', 01:40:05 INFO - 'USER': 'cltbld', 01:40:05 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:05 INFO - '_': '/tools/buildbot/bin/python'} 01:40:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:05 INFO - Downloading/unpacking mozsystemmonitor==0.3 01:40:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:40:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:40:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:40:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:40:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:40:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:40:07 INFO - Downloading mozsystemmonitor-0.3.tar.gz 01:40:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 01:40:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 01:40:07 INFO - Installing collected packages: mozsystemmonitor 01:40:07 INFO - Running setup.py install for mozsystemmonitor 01:40:07 INFO - Successfully installed mozsystemmonitor 01:40:07 INFO - Cleaning up... 01:40:07 INFO - Return code: 0 01:40:07 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 01:40:07 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')]} 01:40:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:07 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')]} 01:40:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:07 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:07 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 01:40:07 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 01:40:07 INFO - Using env: {'DISPLAY': ':0', 01:40:07 INFO - 'HOME': '/home/cltbld', 01:40:07 INFO - 'LANG': 'en_US.UTF-8', 01:40:07 INFO - 'LANGUAGE': 'en_US:en', 01:40:07 INFO - 'LOGNAME': 'cltbld', 01:40:07 INFO - 'MAIL': '/var/mail/cltbld', 01:40:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:07 INFO - 'MOZ_NO_REMOTE': '1', 01:40:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:07 INFO - 'NO_EM_RESTART': '1', 01:40:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:07 INFO - 'PWD': '/builds/slave/test', 01:40:07 INFO - 'SHELL': '/bin/bash', 01:40:07 INFO - 'SHLVL': '1', 01:40:07 INFO - 'TERM': 'linux', 01:40:07 INFO - 'TMOUT': '86400', 01:40:07 INFO - 'USER': 'cltbld', 01:40:07 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:07 INFO - '_': '/tools/buildbot/bin/python'} 01:40:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:08 INFO - Downloading/unpacking jsonschema==2.5.1 01:40:08 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 01:40:08 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 01:40:08 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 01:40:08 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 01:40:08 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 01:40:08 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 01:40:10 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 01:40:10 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 01:40:10 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 01:40:10 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 01:40:10 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 01:40:10 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 01:40:10 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 01:40:10 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 01:40:10 INFO - Downloading functools32-3.2.3-2.tar.gz 01:40:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 01:40:10 INFO - warning: no files found matching '*.txt' 01:40:10 INFO - no previously-included directories found matching 'build' 01:40:10 INFO - no previously-included directories found matching 'dist' 01:40:10 INFO - no previously-included directories found matching '.git*' 01:40:10 INFO - Installing collected packages: jsonschema, functools32 01:40:10 INFO - Running setup.py install for functools32 01:40:10 INFO - warning: no files found matching '*.txt' 01:40:10 INFO - no previously-included directories found matching 'build' 01:40:10 INFO - no previously-included directories found matching 'dist' 01:40:10 INFO - no previously-included directories found matching '.git*' 01:40:10 INFO - Successfully installed jsonschema functools32 01:40:10 INFO - Cleaning up... 01:40:10 INFO - Return code: 0 01:40:10 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 01:40:10 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')]} 01:40:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:10 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')]} 01:40:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:10 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:10 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 01:40:10 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 01:40:10 INFO - Using env: {'DISPLAY': ':0', 01:40:10 INFO - 'HOME': '/home/cltbld', 01:40:10 INFO - 'LANG': 'en_US.UTF-8', 01:40:10 INFO - 'LANGUAGE': 'en_US:en', 01:40:10 INFO - 'LOGNAME': 'cltbld', 01:40:10 INFO - 'MAIL': '/var/mail/cltbld', 01:40:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:10 INFO - 'MOZ_NO_REMOTE': '1', 01:40:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:10 INFO - 'NO_EM_RESTART': '1', 01:40:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:10 INFO - 'PWD': '/builds/slave/test', 01:40:10 INFO - 'SHELL': '/bin/bash', 01:40:10 INFO - 'SHLVL': '1', 01:40:10 INFO - 'TERM': 'linux', 01:40:10 INFO - 'TMOUT': '86400', 01:40:10 INFO - 'USER': 'cltbld', 01:40:10 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:10 INFO - '_': '/tools/buildbot/bin/python'} 01:40:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:10 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 01:40:10 INFO - Cleaning up... 01:40:10 INFO - Return code: 0 01:40:10 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 01:40:10 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')]} 01:40:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:10 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')]} 01:40:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:10 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:10 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 01:40:10 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 01:40:10 INFO - Using env: {'DISPLAY': ':0', 01:40:10 INFO - 'HOME': '/home/cltbld', 01:40:10 INFO - 'LANG': 'en_US.UTF-8', 01:40:10 INFO - 'LANGUAGE': 'en_US:en', 01:40:10 INFO - 'LOGNAME': 'cltbld', 01:40:10 INFO - 'MAIL': '/var/mail/cltbld', 01:40:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:10 INFO - 'MOZ_NO_REMOTE': '1', 01:40:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:10 INFO - 'NO_EM_RESTART': '1', 01:40:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:10 INFO - 'PWD': '/builds/slave/test', 01:40:10 INFO - 'SHELL': '/bin/bash', 01:40:10 INFO - 'SHLVL': '1', 01:40:10 INFO - 'TERM': 'linux', 01:40:10 INFO - 'TMOUT': '86400', 01:40:10 INFO - 'USER': 'cltbld', 01:40:10 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:10 INFO - '_': '/tools/buildbot/bin/python'} 01:40:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:10 INFO - Downloading/unpacking blobuploader==1.2.4 01:40:10 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 01:40:10 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 01:40:10 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 01:40:10 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 01:40:10 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 01:40:10 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 01:40:12 INFO - Downloading blobuploader-1.2.4.tar.gz 01:40:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 01:40:12 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 01:40:12 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 01:40:12 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 01:40:12 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 01:40:12 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 01:40:12 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 01:40:12 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 01:40:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 01:40:13 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 01:40:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:40:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:40:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:40:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:40:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:40:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:40:13 INFO - Downloading docopt-0.6.1.tar.gz 01:40:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 01:40:13 INFO - Installing collected packages: blobuploader, requests, docopt 01:40:13 INFO - Running setup.py install for blobuploader 01:40:13 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 01:40:13 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 01:40:13 INFO - Running setup.py install for requests 01:40:14 INFO - Running setup.py install for docopt 01:40:14 INFO - Successfully installed blobuploader requests docopt 01:40:14 INFO - Cleaning up... 01:40:14 INFO - Return code: 0 01:40:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:40:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:14 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:14 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 01:40:14 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 01:40:14 INFO - Using env: {'DISPLAY': ':0', 01:40:14 INFO - 'HOME': '/home/cltbld', 01:40:14 INFO - 'LANG': 'en_US.UTF-8', 01:40:14 INFO - 'LANGUAGE': 'en_US:en', 01:40:14 INFO - 'LOGNAME': 'cltbld', 01:40:14 INFO - 'MAIL': '/var/mail/cltbld', 01:40:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:14 INFO - 'MOZ_NO_REMOTE': '1', 01:40:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:14 INFO - 'NO_EM_RESTART': '1', 01:40:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:14 INFO - 'PWD': '/builds/slave/test', 01:40:14 INFO - 'SHELL': '/bin/bash', 01:40:14 INFO - 'SHLVL': '1', 01:40:14 INFO - 'TERM': 'linux', 01:40:14 INFO - 'TMOUT': '86400', 01:40:14 INFO - 'USER': 'cltbld', 01:40:14 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:14 INFO - '_': '/tools/buildbot/bin/python'} 01:40:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 01:40:14 INFO - Running setup.py (path:/tmp/pip-H9seZw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 01:40:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 01:40:14 INFO - Running setup.py (path:/tmp/pip-st_72e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 01:40:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 01:40:14 INFO - Running setup.py (path:/tmp/pip-uPEUFL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 01:40:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 01:40:14 INFO - Running setup.py (path:/tmp/pip-64Hjdf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 01:40:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 01:40:14 INFO - Running setup.py (path:/tmp/pip-IbTLiq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 01:40:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 01:40:14 INFO - Running setup.py (path:/tmp/pip-dWOENZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 01:40:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 01:40:14 INFO - Running setup.py (path:/tmp/pip-Ydk3Tr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 01:40:15 INFO - Running setup.py (path:/tmp/pip-ETWzpa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 01:40:15 INFO - Running setup.py (path:/tmp/pip-ebE9ix-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 01:40:15 INFO - Running setup.py (path:/tmp/pip-RKAxGc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 01:40:15 INFO - Running setup.py (path:/tmp/pip-Smj0WT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 01:40:15 INFO - Running setup.py (path:/tmp/pip-YBfY6X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 01:40:15 INFO - Running setup.py (path:/tmp/pip-zeS41y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 01:40:15 INFO - Running setup.py (path:/tmp/pip-b25TAi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 01:40:15 INFO - Running setup.py (path:/tmp/pip-WGGlva-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 01:40:15 INFO - Running setup.py (path:/tmp/pip-FTnkO4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 01:40:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 01:40:15 INFO - Running setup.py (path:/tmp/pip-IQYtxh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 01:40:15 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 01:40:15 INFO - Running setup.py install for manifestparser 01:40:15 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 01:40:15 INFO - Running setup.py install for mozcrash 01:40:15 INFO - Running setup.py install for mozdebug 01:40:15 INFO - Running setup.py install for mozdevice 01:40:16 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Installing dm script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Running setup.py install for mozfile 01:40:16 INFO - Running setup.py install for mozhttpd 01:40:16 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Running setup.py install for mozinfo 01:40:16 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Running setup.py install for mozInstall 01:40:16 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Running setup.py install for mozleak 01:40:16 INFO - Running setup.py install for mozlog 01:40:16 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Running setup.py install for moznetwork 01:40:16 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 01:40:16 INFO - Running setup.py install for mozprocess 01:40:16 INFO - Running setup.py install for mozprofile 01:40:17 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 01:40:17 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 01:40:17 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 01:40:17 INFO - Running setup.py install for mozrunner 01:40:17 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 01:40:17 INFO - Running setup.py install for mozscreenshot 01:40:17 INFO - Running setup.py install for moztest 01:40:17 INFO - Running setup.py install for mozversion 01:40:17 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 01:40:17 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 01:40:17 INFO - Cleaning up... 01:40:17 INFO - Return code: 0 01:40:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:40:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:17 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:17 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 01:40:17 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 01:40:17 INFO - Using env: {'DISPLAY': ':0', 01:40:17 INFO - 'HOME': '/home/cltbld', 01:40:17 INFO - 'LANG': 'en_US.UTF-8', 01:40:17 INFO - 'LANGUAGE': 'en_US:en', 01:40:17 INFO - 'LOGNAME': 'cltbld', 01:40:17 INFO - 'MAIL': '/var/mail/cltbld', 01:40:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:17 INFO - 'MOZ_NO_REMOTE': '1', 01:40:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:17 INFO - 'NO_EM_RESTART': '1', 01:40:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:17 INFO - 'PWD': '/builds/slave/test', 01:40:17 INFO - 'SHELL': '/bin/bash', 01:40:17 INFO - 'SHLVL': '1', 01:40:17 INFO - 'TERM': 'linux', 01:40:17 INFO - 'TMOUT': '86400', 01:40:17 INFO - 'USER': 'cltbld', 01:40:17 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:17 INFO - '_': '/tools/buildbot/bin/python'} 01:40:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 01:40:17 INFO - Running setup.py (path:/tmp/pip-1an4rf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 01:40:17 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)) 01:40:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 01:40:17 INFO - Running setup.py (path:/tmp/pip-Bq1PEt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 01:40:17 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)) 01:40:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 01:40:17 INFO - Running setup.py (path:/tmp/pip-Z09_f9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 01:40:17 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)) 01:40:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 01:40:17 INFO - Running setup.py (path:/tmp/pip-TgBl1I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 01:40:18 INFO - Running setup.py (path:/tmp/pip-zuWRf_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 01:40:18 INFO - Running setup.py (path:/tmp/pip-SKJQJc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 01:40:18 INFO - Running setup.py (path:/tmp/pip-AxyQfA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 01:40:18 INFO - Running setup.py (path:/tmp/pip-ZqCvI8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 01:40:18 INFO - Running setup.py (path:/tmp/pip-r5E7qN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 01:40:18 INFO - Running setup.py (path:/tmp/pip-Nvz4gM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 01:40:18 INFO - Running setup.py (path:/tmp/pip-HuCVVA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 01:40:18 INFO - Running setup.py (path:/tmp/pip-COLXnv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 01:40:18 INFO - Running setup.py (path:/tmp/pip-OqONvo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 01:40:18 INFO - Running setup.py (path:/tmp/pip-4dqKRT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 01:40:18 INFO - Running setup.py (path:/tmp/pip-Qlfveq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 01:40:18 INFO - Running setup.py (path:/tmp/pip-1hlnTo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 01:40:18 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)) 01:40:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 01:40:18 INFO - Running setup.py (path:/tmp/pip-4dqXEz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 01:40:18 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)) 01:40:18 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)) 01:40:18 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)) 01:40:18 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)) 01:40:18 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)) 01:40:18 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)) 01:40:18 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 01:40:18 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 01:40:18 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 01:40:18 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 01:40:18 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 01:40:18 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 01:40:18 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 01:40:21 INFO - Downloading blessings-1.6.tar.gz 01:40:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 01:40:21 INFO - Installing collected packages: blessings 01:40:21 INFO - Running setup.py install for blessings 01:40:21 INFO - Successfully installed blessings 01:40:21 INFO - Cleaning up... 01:40:21 INFO - Return code: 0 01:40:21 INFO - Done creating virtualenv /builds/slave/test/build/venv. 01:40:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 01:40:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 01:40:21 INFO - Reading from file tmpfile_stdout 01:40:21 INFO - Current package versions: 01:40:21 INFO - argparse == 1.2.1 01:40:21 INFO - blessings == 1.6 01:40:21 INFO - blobuploader == 1.2.4 01:40:21 INFO - docopt == 0.6.1 01:40:21 INFO - functools32 == 3.2.3-2 01:40:21 INFO - jsonschema == 2.5.1 01:40:21 INFO - manifestparser == 1.1 01:40:21 INFO - mozInstall == 1.12 01:40:21 INFO - mozcrash == 0.17 01:40:21 INFO - mozdebug == 0.1 01:40:21 INFO - mozdevice == 0.48 01:40:21 INFO - mozfile == 1.2 01:40:21 INFO - mozhttpd == 0.7 01:40:21 INFO - mozinfo == 0.9 01:40:21 INFO - mozleak == 0.1 01:40:21 INFO - mozlog == 3.4 01:40:21 INFO - moznetwork == 0.27 01:40:21 INFO - mozprocess == 0.23 01:40:21 INFO - mozprofile == 0.28 01:40:21 INFO - mozrunner == 6.12 01:40:21 INFO - mozscreenshot == 0.1 01:40:21 INFO - mozsystemmonitor == 0.3 01:40:21 INFO - moztest == 0.7 01:40:21 INFO - mozversion == 1.4 01:40:21 INFO - psutil == 3.1.1 01:40:21 INFO - requests == 1.2.3 01:40:21 INFO - wsgiref == 0.1.2 01:40:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:40:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:21 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:21 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 01:40:21 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 01:40:21 INFO - Using env: {'DISPLAY': ':0', 01:40:21 INFO - 'HOME': '/home/cltbld', 01:40:21 INFO - 'LANG': 'en_US.UTF-8', 01:40:21 INFO - 'LANGUAGE': 'en_US:en', 01:40:21 INFO - 'LOGNAME': 'cltbld', 01:40:21 INFO - 'MAIL': '/var/mail/cltbld', 01:40:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:21 INFO - 'MOZ_NO_REMOTE': '1', 01:40:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:21 INFO - 'NO_EM_RESTART': '1', 01:40:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:21 INFO - 'PWD': '/builds/slave/test', 01:40:21 INFO - 'SHELL': '/bin/bash', 01:40:21 INFO - 'SHLVL': '1', 01:40:21 INFO - 'TERM': 'linux', 01:40:21 INFO - 'TMOUT': '86400', 01:40:21 INFO - 'USER': 'cltbld', 01:40:21 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:21 INFO - '_': '/tools/buildbot/bin/python'} 01:40:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 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)) 01:40:21 INFO - Cleaning up... 01:40:21 INFO - Return code: 0 01:40:21 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 01:40:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:40:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:40:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:40:21 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 0x7f85d7d51f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cd48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1da1ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, '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': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', '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 01:40:21 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 01:40:21 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 01:40:21 INFO - Using env: {'DISPLAY': ':0', 01:40:21 INFO - 'HOME': '/home/cltbld', 01:40:21 INFO - 'LANG': 'en_US.UTF-8', 01:40:21 INFO - 'LANGUAGE': 'en_US:en', 01:40:21 INFO - 'LOGNAME': 'cltbld', 01:40:21 INFO - 'MAIL': '/var/mail/cltbld', 01:40:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:21 INFO - 'MOZ_NO_REMOTE': '1', 01:40:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:21 INFO - 'NO_EM_RESTART': '1', 01:40:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:21 INFO - 'PWD': '/builds/slave/test', 01:40:21 INFO - 'SHELL': '/bin/bash', 01:40:21 INFO - 'SHLVL': '1', 01:40:21 INFO - 'TERM': 'linux', 01:40:21 INFO - 'TMOUT': '86400', 01:40:21 INFO - 'USER': 'cltbld', 01:40:21 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:21 INFO - '_': '/tools/buildbot/bin/python'} 01:40:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:40:21 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 01:40:21 INFO - Cleaning up... 01:40:21 INFO - Return code: 0 01:40:21 INFO - Running post-action listener: _resource_record_post_action 01:40:21 INFO - Running post-action listener: _start_resource_monitoring 01:40:22 INFO - Starting resource monitoring. 01:40:22 INFO - [mozharness: 2016-10-19 08:40:22.002914Z] Finished create-virtualenv step (success) 01:40:22 INFO - [mozharness: 2016-10-19 08:40:22.003379Z] Running install step. 01:40:22 INFO - Running pre-action listener: _resource_record_pre_action 01:40:22 INFO - Running main action method: install 01:40:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 01:40:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 01:40:22 INFO - Reading from file tmpfile_stdout 01:40:22 INFO - Detecting whether we're running mozinstall >=1.0... 01:40:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 01:40:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 01:40:22 INFO - Reading from file tmpfile_stdout 01:40:22 INFO - Output received: 01:40:22 INFO - Usage: mozinstall [options] installer 01:40:22 INFO - Options: 01:40:22 INFO - -h, --help show this help message and exit 01:40:22 INFO - -d DEST, --destination=DEST 01:40:22 INFO - Directory to install application into. [default: 01:40:22 INFO - "/builds/slave/test"] 01:40:22 INFO - --app=APP Application being installed. [default: firefox] 01:40:22 INFO - mkdir: /builds/slave/test/build/application 01:40:22 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'] 01:40:22 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 01:40:38 INFO - Reading from file tmpfile_stdout 01:40:38 INFO - Output received: 01:40:38 INFO - /builds/slave/test/build/application/firefox/firefox 01:40:38 INFO - Running post-action listener: _resource_record_post_action 01:40:38 INFO - [mozharness: 2016-10-19 08:40:38.343793Z] Finished install step (success) 01:40:38 INFO - [mozharness: 2016-10-19 08:40:38.344038Z] Running run-tests step. 01:40:38 INFO - Running pre-action listener: _resource_record_pre_action 01:40:38 INFO - Running main action method: run_tests 01:40:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 01:40:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 01:40:38 INFO - Python 2.7.3 01:40:38 INFO - Return code: 0 01:40:38 INFO - grabbing minidump binary from tooltool 01:40:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:40:38 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 0x1d9ef60>, '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 0x1d9fd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1da01d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 01:40:38 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 01:40:38 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 01:40:38 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 01:40:38 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 01:40:38 INFO - Return code: 0 01:40:38 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 01:40:38 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 01:40:38 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 01:40:38 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 01:40:38 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 01:40:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--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 01:40:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-045 --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 01:40:38 INFO - Using env: {'DISPLAY': ':0', 01:40:38 INFO - 'HOME': '/home/cltbld', 01:40:38 INFO - 'LANG': 'en_US.UTF-8', 01:40:38 INFO - 'LANGUAGE': 'en_US:en', 01:40:38 INFO - 'LOGNAME': 'cltbld', 01:40:38 INFO - 'MAIL': '/var/mail/cltbld', 01:40:38 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 01:40:38 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 01:40:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:40:38 INFO - 'MOZ_NO_REMOTE': '1', 01:40:38 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 01:40:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:40:38 INFO - 'NO_EM_RESTART': '1', 01:40:38 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:40:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:40:38 INFO - 'PWD': '/builds/slave/test', 01:40:38 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 01:40:38 INFO - 'SHELL': '/bin/bash', 01:40:38 INFO - 'SHLVL': '1', 01:40:38 INFO - 'TERM': 'linux', 01:40:38 INFO - 'TMOUT': '86400', 01:40:38 INFO - 'USER': 'cltbld', 01:40:38 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1476866383.846336-1371870119', 01:40:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:40:38 INFO - '_': '/tools/buildbot/bin/python'} 01:40:38 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--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 01:40:38 INFO - mozversion application_buildid: 20161019005522 01:40:38 INFO - mozversion application_changeset: e4282badddda00fb555bd2e5300c92149434a884 01:40:38 INFO - mozversion application_display_name: Nightly 01:40:38 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 01:40:38 INFO - mozversion application_name: Firefox 01:40:38 INFO - mozversion application_remotingname: firefox 01:40:38 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 01:40:38 INFO - mozversion application_vendor: Mozilla 01:40:38 INFO - mozversion application_version: 52.0a1 01:40:38 INFO - mozversion platform_buildid: 20161019005522 01:40:38 INFO - mozversion platform_changeset: e4282badddda00fb555bd2e5300c92149434a884 01:40:38 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 01:40:38 INFO - mozversion platform_version: 52.0a1 01:40:38 INFO - using testdate: 1476866438 01:40:38 INFO - actual date: 1476866438 01:40:38 INFO - starting webserver on 'localhost:59701' 01:40:38 INFO - SUITE-START | Running 2 tests 01:40:38 INFO - TEST-START | dromaeo_css 01:40:38 INFO - operating with platform_type : linux_ 01:40:38 INFO - Initialising browser for dromaeo_css test... 01:40:38 INFO - TEST-INFO | started process 14916 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpC34xSs/profile http://localhost:59701/getInfo.html) 01:40:43 INFO - PROCESS | 14916 | __metrics Screen width/height:1600/1200 01:40:43 INFO - PROCESS | 14916 | colorDepth:24 01:40:43 INFO - PROCESS | 14916 | Browser inner width/height: 1024/697 01:40:43 INFO - PROCESS | 14916 | __metrics 01:40:43 INFO - PROCESS | 14916 | 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" 01:40:43 INFO - PROCESS | 14916 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:40:44 INFO - PROCESS | 14916 | console.error: PushService: 01:40:44 INFO - PROCESS | 14916 | stateChangeProcessEnqueue: Error transitioning state 01:40:44 INFO - PROCESS | 14916 | UnknownError 01:40:45 INFO - TEST-INFO | 14916: exit 0 01:40:45 INFO - Browser initialized. 01:40:45 INFO - Running cycle 1/1 for dromaeo_css test... 01:40:45 INFO - TEST-INFO | started process 15001 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpC34xSs/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:40:57 INFO - PROCESS | 15001 | RSS: Main: 173477888 01:40:57 INFO - PROCESS | 15001 | 01:41:48 INFO - PROCESS | 15001 | 1476866508138 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] 01:44:02 INFO - PROCESS | 15001 | Cycle 1(1): loaded http://localhost:59701/tests/dromaeo/cssquery-dojo.html (next: http://localhost:59701/tests/dromaeo/cssquery-ext.html) 01:44:03 INFO - PROCESS | 15001 | RSS: Main: 293150720 01:44:03 INFO - PROCESS | 15001 | 01:47:06 INFO - PROCESS | 15001 | Cycle 1(1): loaded http://localhost:59701/tests/dromaeo/cssquery-ext.html (next: http://localhost:59701/tests/dromaeo/cssquery-jquery.html) 01:47:07 INFO - PROCESS | 15001 | RSS: Main: 284307456 01:47:07 INFO - PROCESS | 15001 | 01:50:09 INFO - PROCESS | 15001 | Cycle 1(1): loaded http://localhost:59701/tests/dromaeo/cssquery-jquery.html (next: http://localhost:59701/tests/dromaeo/cssquery-mootools.html) 01:50:10 INFO - PROCESS | 15001 | RSS: Main: 257560576 01:50:10 INFO - PROCESS | 15001 | 01:53:12 INFO - PROCESS | 15001 | Cycle 1(1): loaded http://localhost:59701/tests/dromaeo/cssquery-mootools.html (next: http://localhost:59701/tests/dromaeo/cssquery-prototype.html) 01:53:12 INFO - PROCESS | 15001 | RSS: Main: 238055424 01:53:12 INFO - PROCESS | 15001 | 01:56:16 INFO - PROCESS | 15001 | Cycle 1(1): loaded http://localhost:59701/tests/dromaeo/cssquery-prototype.html (next: http://localhost:59701/tests/dromaeo/cssquery-yui.html) 01:56:16 INFO - PROCESS | 15001 | RSS: Main: 218533888 01:56:16 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | Cycle 1(1): loaded http://localhost:59701/tests/dromaeo/cssquery-yui.html (next: http://localhost:59701/tests/dromaeo/cssquery-dojo.html) 01:59:19 INFO - PROCESS | 15001 | RSS: Main: 309104640 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | __start_tp_report 01:59:19 INFO - PROCESS | 15001 | _x_x_mozilla_page_load 01:59:19 INFO - PROCESS | 15001 | _x_x_mozilla_page_load_details 01:59:19 INFO - PROCESS | 15001 | |i|pagename|runs| 01:59:19 INFO - PROCESS | 15001 | |0;dojo.html;2579.4067364506163;2614.830036047658;2636.0510216322123;2656.1898620920624;2665.560182569875;4574.771261436923;4640.373549570807;4785.066911952171;4797.880052998677;4804.975975120124;4646.883827904304;4683.367745354376;4724.338592597031;4763.857084287477;4785.712857228568;4346.174226896896;4376.7811609419405;4416.514183439819;4423.889402764925;4434.423524941753;4437.5340589237985;4478.664100192498;4480.775961201927;4483.529229430912;4502.189605870942;4270.4234928284595;4416.3596278539435;4416.911661766747;4432.911341773162;4523.117991991563;4308.202982448257;4320.351947207912;4373.671974601918;4378.452693413324;4394.4067550880545;4360.978195109004;4365.607095361433;4377.102693947733;4430.534793846664;4433.756143412111;4697.87268026313;4733.83431579893;4752.643551733599;4773.80904763809;4810.5670489656095;4938.753062346904;4992.101421744084;4997.175466048097;4999.825006124768;5057.974710126463;5069.569086627641;5082.1360368737405;5082.923756143661;5132.923006154911;5138.075146473633;4714.316424118484;4728.952710472851;4733.479317275097;4740.525947405232;4796.112719146969;5055.039542486916;5138.177891537411;5177.197534382101;5178.533931946067;5247.449017853147;4923.729194894244;4974.1543937530705;4999.150144475448;5006.249062640633;5067.239914012927;5044.394672639233;5058.4435712071645;5065.670731402447;5071.290019397287;5131.358580177478;4986.626003049713;5020.874478138076;5036.949630503721;5039.0929632666475;5050.191969284897;4941.1847045237855;4953.23224900141;5004.84985450437;5007.924881126786;5012.874678133076;4336;4348.108637729258;4350.042990542076;4395.890102747457;4402.955970440319;3784.6026167252594;3789.6778773803985;3798.1454172810895;3815.7138214634015;3836.9424458633143;4268.722533035343;4322.459692538433;4334.5882141196535;4339.305711086211;4388.692791504564;5028.547430731179;5076.949230507722;5079.517445842639;5083.339165908408;5083.415407228216;4344.847930322424;4345;4347.087111706577;4347.413099231627;4355.107203023373;4456.732596044248;4522.34426008227;4532.750698711537;4538.478075021349;4549.294859296814;4798.880027999188;4846.248831431134;4855.6601037927;4856.3201151838775;4858.708477491362;5116.181410974226;5119.206522988943;5123.820666276662;5130.256112863689;5182;4658.440987081572;4797.040591881568;4800.231962885921;4805.087033463631;4861.7326047066335;4955.058538877602;4977.178765503651;5003.224500202475;5020.447750747488;5030.496950304941;5095.312132862016;5104.2088476286235;5106.183010718267;5117.155669314521;5154.046501397253;4970.3290055842;4973.5523802857915;4975.402951645826;4976.975115124401;5031.119554078095;4818.542238487338;4878.56092951636;4885.853424397274;4896.975515122402;4938.432080310667;4869.220924652039;4890.975545122252;4894.167991441393;4945.035718034948;4955.603551715782;4962.900741985212;4967.577755890645;4969.676970996874;4969.8260560881645;5028.949710502994;4786.545278198566;4835.6131509479865;4853.830115945925;4872.829450969199;4926.4088309403105 01:59:19 INFO - PROCESS | 15001 | |1;ext.html;573.4237091722817;574.0700065893253;583.6818933681146;586.0184191479271;588.9793857214999;27621.447571048593;38625.80687096564;39680.80159599205;39800.60199398005;43459;38865.80567097168;39318.21363572727;39390.40914386287;39520.40719389211;39532.20935581287;7513.924860751391;7668.578228197447;7673.846523069536;7675.347595454366;7677.731279405222;7524.2851929066655;7583.355414789722;7591.430642701792;7611.048618922635;7615.504992175519;7598.126215485235;7645.770626881174;7650.120236172856;7667.463277570572;7671.309582137606;7612.314891659749;7643.847123057508;7646;7658.923410765877;7659.770206893774;7552.660130294095;7593.164751877289;7618.428617853683;7619.695212191506;7622.199669034782;36645;36924;36969.260614787556;36969.63030369716;37010.8149459251;2918.37254990176;2928.2972086699037;3049.817010979348;3158.8262645554487;3311.867525298985;27735.861320693468;27846.721532784617;28397.290067748265;28628.427431451255;31570;3330.8001519908885;3402;3422.687557238677;3431.9485207721905;3447.3967055765143;250203;251631;251715.96568068536;251963;252738;52405.213921791204;53088.73455632774;53113.7344313276;53164.46835531595;53189.542679725695;32438.513422298685;32469;32580.185495362806;35075.12312192216;35114.12214694602;15338.76991845101;15535.45625903088;15538.145402002772;15541.533753987398;15544.689106217813;11393.601223957121;11514.194006419637;11521.827172592419;11525.769484610428;11531.88468115325;17688.380906668463;17730.468085957444;17835.643287134186;17893.7315940261;17896.91051544734;6624.337566243434;6783.321667833177;6862.142232220973;7020.719171233196;7133.964330178316;784.1766145547152;873.6854732296368;899.8560230363111;903.8282726281985;910.4264313482464;26472.941211545996;26881.731182688312;27389.863050685017;27630.723692762815;27722.44555108927;769.5305863423307;945.2626950978248;956.7655924298591;966.6520052780993;1000.1148983149965;13652.931735341259;14417;14523.440325385314;14596.927015364856;14744.41022359115;379074;382654;383560;383844;384948;49367.50632493701;49881.50118498768;49892.750536247084;49969;50003.999360102935;1070.1224995503767;1085.0885256384674;1086.098538213281;1131.479519421059;1176.817593273044;22188.556228875656;27182.592261116493;30492;30842.383152337276;31175.376492470477;45096.323555146046;45681.54318456773;45754.54245457503;45823.541764581925;45830;325310;327233;328203;328400;329526;23881;24892.75107248977;24967;24971.375715607253;24983.250502484956;40317.1936561273;40411;40750.184996299315;40763.38854917238;41253;34826.12934676653;34947.30105397827;35133.121671957386;35320.47019294661;35343;34525.65474345224;34650.82674586611;34858.65141348554;34900;35175.296494069466;34014.319713606084;34453.82773086119;34585.135371615914;34708.65291347054;35271.470927936614;28695.185678237565;30495.390092197587;30744.231394215323;30942.69057309398;31084.56010258147;23849.284521464382;24077.036918523765;24379.39051523726;24807.87596062008;24873.626895596943 01:59:19 INFO - PROCESS | 15001 | |2;jquery.html;341.9195342717015;357.6602227883511;362.1525630025739;363.7908202783399;384.95957924417934;12141.757164856708;13209.867901320997;15816.604584885383;16556.420525281617;17557.297708091693;17304.13479326035;17541.298348066095;17609.855359401663;17617.119144042812;17724.1137943103;4830.251311046784;5091.185410334348;5094.032133894567;5149.562287205574;5429.809956651518;5319.707416092114;5356.571474282048;5359.08895487768;5361.249425080492;6638.1370421845095;6947.513674042819;6985.82535436613;7082.575045497261;7083.079199704057;7094.219635840053;6765.086713293692;6861.210960739529;6895.241523432418;6899.75850845218;7088.6810093545655;6441.484681225491;6658.733650653968;6664.900026499607;6666.799996000128;6833.111695479556;22347.888260558593;22565.435864103365;23018;23115.653265201036;23153.768462315496;1913.6938089905686;1919.7928854148488;2128.7445506539316;2219.9223027194134;2419.903203871843;13356.398962046731;13964.301784910815;14126.576202713935;14429.783553246709;14836.406543738238;1767.5139336682387;1793.8026817050113;1796.3443343179777;1847.3626598823384;1890.867639265252;80391.59804201;82908;83264.58367708123;84208.57895710543;84752.15247847504;15630.374785008473;15892.284847181905;15904.522864314089;15927.362905483651;16265.593360165854;28433;28493.857530712216;28542;28555.857220713762;28749.856250718614;7984.710959915248;8322.750317490485;8420.957895210484;8433.367497437594;8593.140685931481;6864.485163612749;6869.553479023847;7179.641017949081;7179.784606461814;7200.531965422231;8006.359491240803;8007.474842358753;8026.799330016796;8103.230193131761;8129.1870812919415;3178.825164615922;3216.276337823971;3267.4118658641196;3280.7539434542505;3291.588551431071;330.93610463508156;337.4044810908748;374.5486688540302;376.70052308414876;747.069897977022;10048.497575121215;10634.521446534924;10676.786464270826;10767.89232107669;11119.555217791198;382.7952045655561;395.64984988285573;406.19167855967004;408.0288912388496;416.0140467093009;5608.6073974821375;5679.659220446786;5719;5798.971005145032;5829.795957141565;388148;395911;397838;398582;401107;75008.62495687486;76493;77045.22954770493;79579;81145.59427202944;402.94358789769456;413.6628647652214;413.9981245386173;414.2791542715713;414.75943952507475;7939.761807145795;9908.801823963624;9995.950020249853;10012.59949602037;10164.542595583069;35022.29955400827;37165;38683;39318;40109.98625171853;50210;50690.74654626703;50794.49205508045;51026.489735103656;51114.48885511246;6993.0908981832035;7183.461240407095;7284.817879553054;7391.371733402721;7513.549187048795;9794.26543009263;10525.631667883126;11168.1065514757;11281.71795705114;11710.765784684429;9798.608055677692;9869.407835529892;9973.551190196313;10262.127719143957;10580.985040504762;9540.189083927944;9572.56923438433;9679.467629280458;10107.545160467944;10285.382877027403;9855.768028996376;9881.456519891475;10164.745881353025;10405.855355910693;10465.424401657981;7508.549487030796;7632.5038872473115;7649.579273140031;7656.540607563564;7783.260590243918;9495.192908602847;9656;9831.459269739948;10087.798244035224;10335.586576536854 01:59:19 INFO - PROCESS | 15001 | |3;mootools.html;1361.2717196299982;1417.56764186923;1495.8429364916683;1645.3254165792014;1715.8026826914909;6732.52872298938;6920.896186557193;7500.887486687698;8045;8064.112947575769;7369.668364923578;7636.7708968730885;7648.847023059536;7778.6888524458955;7784.805379865506;2110.5040315525875;2137.8931053447263;2142.2609199826034;2142.850000499958;2155.493459037125;1788.3651303787099;1841.0058568373063;2095.9476013099643;2103.8842863642494;2132.6694362373855;2136.081484961466;2177.0203408466173;2177.085624037908;2178.771229020954;2182.8362872784523;2090.3310940499046;2097.727295451597;2106.115431518758;2124.1609564222044;2138.315738963532;2080.4070839810583;2094.6648536234284;2099.601075795594;2104.9263275785274;2109.0298462707174;7845.293923546908;7884.960575197088;7902.960485197595;7910.80222994424;7921.524708517507;4419.513853476115;4617.907641847144;4619.330197121399;4627.028324051953;4629.722216667011;2707.742764437375;2840.1479556133077;2881.7406433421093;2922.1233629910944;2922.473954688155;856.2165618459103;869.3740506835069;876.2245412809646;891.9420237684594;892.607252808762;10802.621908233174;10870.021698047134;10878.564857405694;10909.509072091774;10917.672469825919;3958.4656071430563;4097.610726980932;4310.137972405531;4317.784110794448;4318.52496225415;9217.170454658979;9304.25565954722;9308.813823723487;9317.254619630414;9317.860232096524;4669.509701481364;4676.742779147112;4677.742724150136;4684.273937539687;4688.9531104689195;4146.688998325138;4186.497620285585;4202.474690663667;4208.032152604918;4212.873613791591;3595.9101022474647;3613.765105268149;3686.1153323202775;3704.073981504624;3705.94441083384;1025.2464438637596;1081.0540776820283;1161.2742036227357;1175.5591653130077;1180.6044974933493;614.9385061493815;691.6472598974559;772.6368606754817;780.2158830375437;783.8432313537315;4745.572898439157;4807.78364973577;4909.214525675875;4953.0589188054155;5006.249062640633;830.9654480172225;835.8411901738772;839.5382539603194;852.9232369086812;876.0932434929817;3250.5286733423995;3329.4027883748277;3370.8651653933566;3392.8642854286045;3448.3620530201993;9094.636214551476;9392.577334019985;9502.382345147544;9639.325247232626;9639.71080867575;9571.664991725256;9606.039396060338;9608.95195524018;9613.279004074582;9616.134547890724;6938.779590530981;6950.235474097845;7036.788896333118;7049.506534542636;7077.150741911004;4913.606911447004;4965.751712414437;5010.023045506237;5024.773885175103;5084.6440749147205;8635.6977505787;8796.076411976906;8806.119388061143;8841.823163536821;8845.336599754915;9034.864477032981;9067.637294508146;9131.634734610807;9155.176034156957;9156.633734650539;6719.428848547928;6833.965830170818;6844.486663500357;6878.7248510059035;6879.552829066095;7056.6471676417;7235.746748863765;7320.487565870338;7570.5836179010685;7635.847283054197;5009.223570346602;6300.71646775887;6334.683265836782;6521.478281737354;6676.766313179015;6063.969680151571;6137.723802428812;6177.96911015442;6319.905201422074;6364.840878977878;5681.034224181816;5728.369879313355;5760;5762.2221000164445;5772.2207501986695;4175;4244.7877606118955;4306.63393611534;4375.103103863764;4428.269335559726;4147.564505726855;4204.768737719455;4253.27694291965;4256.851010214627;4282.379055037064 01:59:19 INFO - PROCESS | 15001 | |4;prototype.html;284.94443583501214;286.2086331293972;294.0971218359636;294.2995670304675;294.62582520199345;4863.440704319004;4889.559939605435;4896.681715688478;4939.481354457784;4948.604111671067;4510.887227819298;4637.953620463794;4668.18306796311;4747.976260118703;4809.158397280471;3777.3956167013284;3785.413260944558;3803.315403227418;3806.276807406584;3816.8167867960883;3812.390017597185;3817.141143242762;3818.293615681094;3839.9616003839883;3840.347140986039;3609.9458508122398;3652.543432070991;3713.9442908356395;3736.2527494501073;3786.488824008765;3730.1420673245307;3730.7575007624555;3739.8317075731657;3745.3071181831447;3752.0921286003295;3292.4732042873025;3295.2585668224697;3297.274599588087;3311.9503207451908;3313.204830840605;4474.261746811805;4729.385179926622;4738.384010078667;4748.5014073522125;4752.334673145762;4149.937750933738;4206.663466922639;4232.957670423287;4251.91496170078;4279.87160385189;5029.84910452687;5033.773480193364;5058.620603454719;5125.333706618153;5137.460566640486;3533.1873669056004;3538.8053657048854;3549.964500354989;3550.2899420115823;3575.481555174485;5012.473690262506;5253.212018197301;5264.289320941701;5306.734663266821;5368.570514358842;3603.4594810778594;3608.6210947850623;3613.2412193439145;3619.077135330474;3626.9637303627155;3655.3785856404475;3670.1742108025483;3670.944935825965;3685.5208822852856;3698.223373091627;4148.377743338463;4164.9583504165175;4276.5723427656985;4277.123189746095;4288.335308027261;5037.222083437422;5043.84868453947;5056.738403729574;5057.898842023213;5071.644984851025;1250.9186902851286;1262.4950019992077;1270.371166272701;1271.815586739936;1273.7579859826603;799.2606838674203;817.0644611919438;836.0469065265602;859.0807835615956;864.9740507784651;4430.847979525347;4441.333799930037;4444.955550444454;4457.9331310030375;4469.329600559942;5142.280080788692;5185.403678577012;5195.584353251731;5197;5200.63595548308;4303;4363.170997510463;4424.446944131983;4435.6229720473475;4440.311751678495;2751.284665986858;2753.8898444062015;2761.254461295439;2765.502209602251;2771.256456108438;4836.202026665561;4839.927401088916;4862.78117484714;4866.197077482176;4877.731724755173;5027.371578552681;5209.192575150858;5213.504717051874;5300.475184002595;5302.92045619316;4761.809527618856;4777.546133117348;4787.736674482937;4791.616670666408;4816.8554943351755;5122;5156.416290677943;5164.347408829139;5172.5603323717905;5197.636165468532;4916.582090522203;5038.445770965118;5043.268726034631;5082.822101226439;5082.847514574569;4758;4783.306420569068;4791.425028996543;4811.879703007453;4823.855284341475;3582.9104272392356;3604.7837129772297;3626.238489917147;3626.709863210884;3629.872954446582;5022.924656130088;5105.183170692671;5134.12719837621;5172.482751724798;5199.220116982483;4973.104841128632;4975.9053008338105;4981.651284410056;4983.700977941335;4988.653063672716;4961.776720047535;4964;5005.749712514433;5052.317937078595;5061.974690126526;4669.252919532859;4873.951260487492;4891.926621100615;4917.680350777331;4922.4585295616735;4806.927896081632;4937.185364414975;4950.336750804451;5050.939302746465;5074.644774865724;4963.9007219854675;4968.850934471971;4968.925466118083;4972.577330926912;5016.648834581691 01:59:19 INFO - PROCESS | 15001 | |5;yui.html;597.3250227243215;679.7722762874437;695.3602685529313;719.9740369972787;720.4128635162339;11826.231294965832;12330.383480825967;12339.136260461772;12400.937995310034;12470.314132722697;12602.243865368084;12752.171108877916;12755.107142500006;12765.80851287229;12771.233725976424;603.0893351039917;753;753.1978442958259;761.0562902001534;764.7017663111391;639.1307821362942;766.5362455714296;790.2216316927821;791.2759824760337;797.5892415406071;804.1194891593696;804.3203493048394;804.4047404920346;804.5735760047185;806.4959400374765;656.7537173559915;675.0178490296606;794.4081659163902;794.5868148562773;799.2646764976207;496.19616221720685;496.68212344099805;593.4273426143792;610.1701685707434;613.2487702564367;12641.557545485864;12647.49410023598;12648.873511264861;12656;12712.237265764084;11532.88467115335;11735.530578776925;11837.585684501088;11929.642110736691;12618.68453288666;11422.200445968785;11590.362530060844;11638.476268567934;11793.056555475541;11849.407529623484;3843.0968722350226;3898.4152377143373;3898.8440462381473;3933.1936952924866;3996.760194388346;60314.69842650846;60370.09444858331;60375.4906127346;60381.6980915097;61232;9487.573059212353;9836.60653573849;9867.210623150131;9897.752556186153;10057.899421005843;18869.150888210064;18880.62238755245;18894.811051889305;18897.527561811065;18931.43205703831;6455.548111632234;6474.805755827333;6541.6075035498025;6688.230853451818;6781.966090169616;3366.6465021172426;3385.830708464567;3388.9152771180916;3389.7627166098137;3584.605693373727;2662.148112603948;2762.3646561290616;2770.127409865886;2772.3900741836765;2773.88904443824;481.0643298783902;487.59042404379784;498.3770287141074;499.39323721678335;504.4173979054198;400.46737838675074;463.8751028755322;499.3957311652941;515.3815421494147;523.1028785632582;6947.4789390795895;6988.231294557595;7143.678534465961;7160.928390716131;7473.140588832354;507.92635067914944;526.3920172201114;528.2393353570923;533.226821109393;548.2954403591366;3442.6557344265875;3455.706264967456;3628.8729894454095;3631.5823680276576;3714.68425183857;95355;97277;99353;102292;102371;84857;85665.88948008251;86183;87555.56222218848;87862.56068719615;50321.748391258545;61624.69187654033;62249.06626400608;74675.05199168215;79517;8043.758687239392;8263.586820658822;8300.767151384045;8519.105493923296;8520.275776559061;33307.83346083254;34763;40886;41123.532588044814;43630.56369436265;56033.439665602826;59488.405115948284;60799.69600151971;60907;64456.35543644503;10668.359898406121;11821.82267266009;12001.279923204636;12421.31682757457;13046.478140874258;12270.447829847857;12525.123241373016;12583.811242831182;12957.416916238602;13049.28228947417;11107.055900248246;11223.158263130135;11583.189176757545;12322.199057061262;12342.75314493723;11085.347143261402;11599.246049006788;11868.238895265964;12003;12375.133740638068;11203.383813889988;11318.32090074598;11350.375729334635;11470;11677.708057298636;9503.429794212369;9508.239340852853;9768.26737994639;10094.14199793026;10154.289199755945;9038.909610903807;9389.624415023323;9413;9415.608672480948;9426.198773104363 01:59:19 INFO - PROCESS | 15001 | __end_tp_report 01:59:19 INFO - PROCESS | 15001 | __start_cc_report 01:59:19 INFO - PROCESS | 15001 | _x_x_mozilla_cycle_collect,1210 01:59:19 INFO - PROCESS | 15001 | __end_cc_report 01:59:19 INFO - PROCESS | 15001 | __startTimestamp1476867559959__endTimestamp 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | ------- Summary: start ------- 01:59:19 INFO - PROCESS | 15001 | Number of tests: 6 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | [#0] dojo.html Cycles:165 Average:4693.08 Median:4835.61 stddev:485.50 (10.0%) stddev-sans-first:457.80 01:59:19 INFO - PROCESS | 15001 | Values: 2579.4 2614.8 2636.1 2656.2 2665.6 4574.8 4640.4 4785.1 4797.9 4805.0 4646.9 4683.4 4724.3 4763.9 4785.7 4346.2 4376.8 4416.5 4423.9 4434.4 4437.5 4478.7 4480.8 4483.5 4502.2 4270.4 4416.4 4416.9 4432.9 4523.1 4308.2 4320.4 4373.7 4378.5 4394.4 4361.0 4365.6 4377.1 4430.5 4433.8 4697.9 4733.8 4752.6 4773.8 4810.6 4938.8 4992.1 4997.2 4999.8 5058.0 5069.6 5082.1 5082.9 5132.9 5138.1 4714.3 4729.0 4733.5 4740.5 4796.1 5055.0 5138.2 5177.2 5178.5 5247.4 4923.7 4974.2 4999.2 5006.2 5067.2 5044.4 5058.4 5065.7 5071.3 5131.4 4986.6 5020.9 5036.9 5039.1 5050.2 4941.2 4953.2 5004.8 5007.9 5012.9 4336.0 4348.1 4350.0 4395.9 4403.0 3784.6 3789.7 3798.1 3815.7 3836.9 4268.7 4322.5 4334.6 4339.3 4388.7 5028.5 5076.9 5079.5 5083.3 5083.4 4344.8 4345.0 4347.1 4347.4 4355.1 4456.7 4522.3 4532.8 4538.5 4549.3 4798.9 4846.2 4855.7 4856.3 4858.7 5116.2 5119.2 5123.8 5130.3 5182.0 4658.4 4797.0 4800.2 4805.1 4861.7 4955.1 4977.2 5003.2 5020.4 5030.5 5095.3 5104.2 5106.2 5117.2 5154.0 4970.3 4973.6 4975.4 4977.0 5031.1 4818.5 4878.6 4885.9 4897.0 4938.4 4869.2 4891.0 4894.2 4945.0 4955.6 4962.9 4967.6 4969.7 4969.8 5028.9 4786.5 4835.6 4853.8 4872.8 4926.4 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | [#1] ext.html Cycles:180 Average:46711.88 Median:35094.62 stddev:85660.70 (244.1%) stddev-sans-first:85830.95 01:59:19 INFO - PROCESS | 15001 | Values: 573.4 574.1 583.7 586.0 589.0 27621.4 38625.8 39680.8 39800.6 43459.0 38865.8 39318.2 39390.4 39520.4 39532.2 7513.9 7668.6 7673.8 7675.3 7677.7 7524.3 7583.4 7591.4 7611.0 7615.5 7598.1 7645.8 7650.1 7667.5 7671.3 7612.3 7643.8 7646.0 7658.9 7659.8 7552.7 7593.2 7618.4 7619.7 7622.2 36645.0 36924.0 36969.3 36969.6 37010.8 2918.4 2928.3 3049.8 3158.8 3311.9 27735.9 27846.7 28397.3 28628.4 31570.0 3330.8 3402.0 3422.7 3431.9 3447.4 250203.0 251631.0 251716.0 251963.0 252738.0 52405.2 53088.7 53113.7 53164.5 53189.5 32438.5 32469.0 32580.2 35075.1 35114.1 15338.8 15535.5 15538.1 15541.5 15544.7 11393.6 11514.2 11521.8 11525.8 11531.9 17688.4 17730.5 17835.6 17893.7 17896.9 6624.3 6783.3 6862.1 7020.7 7134.0 784.2 873.7 899.9 903.8 910.4 26472.9 26881.7 27389.9 27630.7 27722.4 769.5 945.3 956.8 966.7 1000.1 13652.9 14417.0 14523.4 14596.9 14744.4 379074.0 382654.0 383560.0 383844.0 384948.0 49367.5 49881.5 49892.8 49969.0 50004.0 1070.1 1085.1 1086.1 1131.5 1176.8 22188.6 27182.6 30492.0 30842.4 31175.4 45096.3 45681.5 45754.5 45823.5 45830.0 325310.0 327233.0 328203.0 328400.0 329526.0 23881.0 24892.8 24967.0 24971.4 24983.3 40317.2 40411.0 40750.2 40763.4 41253.0 34826.1 34947.3 35133.1 35320.5 35343.0 34525.7 34650.8 34858.7 34900.0 35175.3 34014.3 34453.8 34585.1 34708.7 35271.5 28695.2 30495.4 30744.2 30942.7 31084.6 23849.3 24077.0 24379.4 24807.9 24873.6 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | [#2] jquery.html Cycles:180 Average:25431.30 Median:414.14 stddev:65674.57 (15858.1%) stddev-sans-first:65831.79 01:59:19 INFO - PROCESS | 15001 | Values: 341.9 357.7 362.2 363.8 385.0 12141.8 13209.9 15816.6 16556.4 17557.3 17304.1 17541.3 17609.9 17617.1 17724.1 4830.3 5091.2 5094.0 5149.6 5429.8 5319.7 5356.6 5359.1 5361.2 6638.1 6947.5 6985.8 7082.6 7083.1 7094.2 6765.1 6861.2 6895.2 6899.8 7088.7 6441.5 6658.7 6664.9 6666.8 6833.1 22347.9 22565.4 23018.0 23115.7 23153.8 1913.7 1919.8 2128.7 2219.9 2419.9 13356.4 13964.3 14126.6 14429.8 14836.4 1767.5 1793.8 1796.3 1847.4 1890.9 80391.6 82908.0 83264.6 84208.6 84752.2 15630.4 15892.3 15904.5 15927.4 16265.6 28433.0 28493.9 28542.0 28555.9 28749.9 7984.7 8322.8 8421.0 8433.4 8593.1 6864.5 6869.6 7179.6 7179.8 7200.5 8006.4 8007.5 8026.8 8103.2 8129.2 3178.8 3216.3 3267.4 3280.8 3291.6 330.9 337.4 374.5 376.7 747.1 10048.5 10634.5 10676.8 10767.9 11119.6 382.8 395.6 406.2 408.0 416.0 5608.6 5679.7 5719.0 5799.0 5829.8 388148.0 395911.0 397838.0 398582.0 401107.0 75008.6 76493.0 77045.2 79579.0 81145.6 402.9 413.7 414.0 414.3 414.8 7939.8 9908.8 9996.0 10012.6 10164.5 35022.3 37165.0 38683.0 39318.0 40110.0 50210.0 50690.7 50794.5 51026.5 51114.5 6993.1 7183.5 7284.8 7391.4 7513.5 9794.3 10525.6 11168.1 11281.7 11710.8 9798.6 9869.4 9973.6 10262.1 10581.0 9540.2 9572.6 9679.5 10107.5 10285.4 9855.8 9881.5 10164.7 10405.9 10465.4 7508.5 7632.5 7649.6 7656.5 7783.3 9495.2 9656.0 9831.5 10087.8 10335.6 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | [#3] mootools.html Cycles:180 Average:5027.76 Median:4986.00 stddev:2881.02 (57.8%) stddev-sans-first:2875.93 01:59:19 INFO - PROCESS | 15001 | Values: 1361.3 1417.6 1495.8 1645.3 1715.8 6732.5 6920.9 7500.9 8045.0 8064.1 7369.7 7636.8 7648.8 7778.7 7784.8 2110.5 2137.9 2142.3 2142.9 2155.5 1788.4 1841.0 2095.9 2103.9 2132.7 2136.1 2177.0 2177.1 2178.8 2182.8 2090.3 2097.7 2106.1 2124.2 2138.3 2080.4 2094.7 2099.6 2104.9 2109.0 7845.3 7885.0 7903.0 7910.8 7921.5 4419.5 4617.9 4619.3 4627.0 4629.7 2707.7 2840.1 2881.7 2922.1 2922.5 856.2 869.4 876.2 891.9 892.6 10802.6 10870.0 10878.6 10909.5 10917.7 3958.5 4097.6 4310.1 4317.8 4318.5 9217.2 9304.3 9308.8 9317.3 9317.9 4669.5 4676.7 4677.7 4684.3 4689.0 4146.7 4186.5 4202.5 4208.0 4212.9 3595.9 3613.8 3686.1 3704.1 3705.9 1025.2 1081.1 1161.3 1175.6 1180.6 614.9 691.6 772.6 780.2 783.8 4745.6 4807.8 4909.2 4953.1 5006.2 831.0 835.8 839.5 852.9 876.1 3250.5 3329.4 3370.9 3392.9 3448.4 9094.6 9392.6 9502.4 9639.3 9639.7 9571.7 9606.0 9609.0 9613.3 9616.1 6938.8 6950.2 7036.8 7049.5 7077.2 4913.6 4965.8 5010.0 5024.8 5084.6 8635.7 8796.1 8806.1 8841.8 8845.3 9034.9 9067.6 9131.6 9155.2 9156.6 6719.4 6834.0 6844.5 6878.7 6879.6 7056.6 7235.7 7320.5 7570.6 7635.8 5009.2 6300.7 6334.7 6521.5 6676.8 6064.0 6137.7 6178.0 6319.9 6364.8 5681.0 5728.4 5760.0 5762.2 5772.2 4175.0 4244.8 4306.6 4375.1 4428.3 4147.6 4204.8 4253.3 4256.9 4282.4 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | [#4] prototype.html Cycles:180 Average:4162.58 Median:4759.90 stddev:1209.93 (25.4%) stddev-sans-first:1177.80 01:59:19 INFO - PROCESS | 15001 | Values: 284.9 286.2 294.1 294.3 294.6 4863.4 4889.6 4896.7 4939.5 4948.6 4510.9 4638.0 4668.2 4748.0 4809.2 3777.4 3785.4 3803.3 3806.3 3816.8 3812.4 3817.1 3818.3 3840.0 3840.3 3609.9 3652.5 3713.9 3736.3 3786.5 3730.1 3730.8 3739.8 3745.3 3752.1 3292.5 3295.3 3297.3 3312.0 3313.2 4474.3 4729.4 4738.4 4748.5 4752.3 4149.9 4206.7 4233.0 4251.9 4279.9 5029.8 5033.8 5058.6 5125.3 5137.5 3533.2 3538.8 3550.0 3550.3 3575.5 5012.5 5253.2 5264.3 5306.7 5368.6 3603.5 3608.6 3613.2 3619.1 3627.0 3655.4 3670.2 3670.9 3685.5 3698.2 4148.4 4165.0 4276.6 4277.1 4288.3 5037.2 5043.8 5056.7 5057.9 5071.6 1250.9 1262.5 1270.4 1271.8 1273.8 799.3 817.1 836.0 859.1 865.0 4430.8 4441.3 4445.0 4457.9 4469.3 5142.3 5185.4 5195.6 5197.0 5200.6 4303.0 4363.2 4424.4 4435.6 4440.3 2751.3 2753.9 2761.3 2765.5 2771.3 4836.2 4839.9 4862.8 4866.2 4877.7 5027.4 5209.2 5213.5 5300.5 5302.9 4761.8 4777.5 4787.7 4791.6 4816.9 5122.0 5156.4 5164.3 5172.6 5197.6 4916.6 5038.4 5043.3 5082.8 5082.8 4758.0 4783.3 4791.4 4811.9 4823.9 3582.9 3604.8 3626.2 3626.7 3629.9 5022.9 5105.2 5134.1 5172.5 5199.2 4973.1 4975.9 4981.7 4983.7 4988.7 4961.8 4964.0 5005.7 5052.3 5062.0 4669.3 4874.0 4891.9 4917.7 4922.5 4806.9 4937.2 4950.3 5050.9 5074.6 4963.9 4968.9 4968.9 4972.6 5016.6 01:59:19 INFO - PROCESS | 15001 | 01:59:19 INFO - PROCESS | 15001 | [#5] yui.html Cycles:180 Average:17256.73 Median:497.53 stddev:24896.26 (5004.0%) stddev-sans-first:24934.68 01:59:19 INFO - PROCESS | 15001 | Values: 597.3 679.8 695.4 720.0 720.4 11826.2 12330.4 12339.1 12400.9 12470.3 12602.2 12752.2 12755.1 12765.8 12771.2 603.1 753.0 753.2 761.1 764.7 639.1 766.5 790.2 791.3 797.6 804.1 804.3 804.4 804.6 806.5 656.8 675.0 794.4 794.6 799.3 496.2 496.7 593.4 610.2 613.2 12641.6 12647.5 12648.9 12656.0 12712.2 11532.9 11735.5 11837.6 11929.6 12618.7 11422.2 11590.4 11638.5 11793.1 11849.4 3843.1 3898.4 3898.8 3933.2 3996.8 60314.7 60370.1 60375.5 60381.7 61232.0 9487.6 9836.6 9867.2 9897.8 10057.9 18869.2 18880.6 18894.8 18897.5 18931.4 6455.5 6474.8 6541.6 6688.2 6782.0 3366.6 3385.8 3388.9 3389.8 3584.6 2662.1 2762.4 2770.1 2772.4 2773.9 481.1 487.6 498.4 499.4 504.4 400.5 463.9 499.4 515.4 523.1 6947.5 6988.2 7143.7 7160.9 7473.1 507.9 526.4 528.2 533.2 548.3 3442.7 3455.7 3628.9 3631.6 3714.7 95355.0 97277.0 99353.0 102292.0 102371.0 84857.0 85665.9 86183.0 87555.6 87862.6 50321.7 61624.7 62249.1 74675.1 79517.0 8043.8 8263.6 8300.8 8519.1 8520.3 33307.8 34763.0 40886.0 41123.5 43630.6 56033.4 59488.4 60799.7 60907.0 64456.4 10668.4 11821.8 12001.3 12421.3 13046.5 12270.4 12525.1 12583.8 12957.4 13049.3 11107.1 11223.2 11583.2 12322.2 12342.8 11085.3 11599.2 11868.2 12003.0 12375.1 11203.4 11318.3 11350.4 11470.0 11677.7 9503.4 9508.2 9768.3 10094.1 10154.3 9038.9 9389.6 9413.0 9415.6 9426.2 01:59:19 INFO - PROCESS | 15001 | -------- Summary: end -------- 01:59:19 INFO - PROCESS | 15001 | 01:59:20 INFO - TEST-INFO | 15001: exit 0 01:59:20 INFO - TEST-OK | dromaeo_css | took 1122335ms 01:59:20 INFO - TEST-START | kraken 01:59:20 INFO - operating with platform_type : linux_ 01:59:20 INFO - Initialising browser for kraken test... 01:59:20 INFO - TEST-INFO | started process 15307 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpphc1EQ/profile http://localhost:59701/getInfo.html) 01:59:25 INFO - PROCESS | 15307 | __metrics Screen width/height:1600/1200 01:59:25 INFO - PROCESS | 15307 | colorDepth:24 01:59:25 INFO - PROCESS | 15307 | Browser inner width/height: 1024/697 01:59:25 INFO - PROCESS | 15307 | __metrics 01:59:25 INFO - PROCESS | 15307 | 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" 01:59:25 INFO - PROCESS | 15307 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:59:26 INFO - PROCESS | 15307 | console.error: PushService: 01:59:26 INFO - PROCESS | 15307 | stateChangeProcessEnqueue: Error transitioning state 01:59:26 INFO - PROCESS | 15307 | UnknownError 01:59:27 INFO - TEST-INFO | 15307: exit 0 01:59:27 INFO - Browser initialized. 01:59:27 INFO - Running cycle 1/1 for kraken test... 01:59:27 INFO - TEST-INFO | started process 15389 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpphc1EQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:59:39 INFO - PROCESS | 15389 | RSS: Main: 173633536 01:59:39 INFO - PROCESS | 15389 | 01:59:42 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:59701/tests/kraken/driver.html?testName=audio-beat-detection) 01:59:43 INFO - PROCESS | 15389 | RSS: Main: 238346240 01:59:43 INFO - PROCESS | 15389 | 01:59:46 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:59701/tests/kraken/driver.html?testName=audio-dft) 01:59:46 INFO - PROCESS | 15389 | RSS: Main: 217526272 01:59:46 INFO - PROCESS | 15389 | 01:59:49 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:59701/tests/kraken/driver.html?testName=audio-fft) 01:59:50 INFO - PROCESS | 15389 | RSS: Main: 299171840 01:59:50 INFO - PROCESS | 15389 | 01:59:52 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:59701/tests/kraken/driver.html?testName=audio-oscillator) 01:59:53 INFO - PROCESS | 15389 | RSS: Main: 210796544 01:59:53 INFO - PROCESS | 15389 | 01:59:55 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:59701/tests/kraken/driver.html?testName=imaging-gaussian-blur) 01:59:56 INFO - PROCESS | 15389 | RSS: Main: 212971520 01:59:56 INFO - PROCESS | 15389 | 01:59:59 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:59701/tests/kraken/driver.html?testName=imaging-darkroom) 01:59:59 INFO - PROCESS | 15389 | RSS: Main: 249090048 01:59:59 INFO - PROCESS | 15389 | 02:00:03 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:59701/tests/kraken/driver.html?testName=imaging-desaturate) 02:00:04 INFO - PROCESS | 15389 | RSS: Main: 243159040 02:00:04 INFO - PROCESS | 15389 | 02:00:06 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:59701/tests/kraken/driver.html?testName=json-parse-financial) 02:00:07 INFO - PROCESS | 15389 | RSS: Main: 245784576 02:00:07 INFO - PROCESS | 15389 | 02:00:09 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:59701/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:00:09 INFO - PROCESS | 15389 | RSS: Main: 209317888 02:00:09 INFO - PROCESS | 15389 | 02:00:11 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:00:12 INFO - PROCESS | 15389 | RSS: Main: 216854528 02:00:12 INFO - PROCESS | 15389 | 02:00:14 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:00:15 INFO - PROCESS | 15389 | RSS: Main: 225693696 02:00:15 INFO - PROCESS | 15389 | 02:00:17 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:00:18 INFO - PROCESS | 15389 | RSS: Main: 234328064 02:00:18 INFO - PROCESS | 15389 | 02:00:21 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:00:22 INFO - PROCESS | 15389 | RSS: Main: 231002112 02:00:22 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:59701/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:59701/tests/kraken/driver.html?testName=ai-astar) 02:00:24 INFO - PROCESS | 15389 | RSS: Main: 281018368 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | __start_tp_report 02:00:24 INFO - PROCESS | 15389 | _x_x_mozilla_page_load 02:00:24 INFO - PROCESS | 15389 | _x_x_mozilla_page_load_details 02:00:24 INFO - PROCESS | 15389 | |i|pagename|runs| 02:00:24 INFO - PROCESS | 15389 | |0;ai-astar;104;114;116;112;114;114;114;114;112;115 02:00:24 INFO - PROCESS | 15389 | |1;audio-beat-detection;158;128;129;167;128;128;126;127;166;130 02:00:24 INFO - PROCESS | 15389 | |2;audio-dft;162;161;162;161;163;163;162;161;161;161 02:00:24 INFO - PROCESS | 15389 | |3;audio-fft;76;77;76;106;77;78;80;77;98;77 02:00:24 INFO - PROCESS | 15389 | |4;audio-oscillator;84;83;130;84;83;83;105;83;83;126 02:00:24 INFO - PROCESS | 15389 | |5;imaging-gaussian-blur;117;117;117;117;117;117;117;117;117;117 02:00:24 INFO - PROCESS | 15389 | |6;imaging-darkroom;148;147;146;147;147;148;145;146;146;146 02:00:24 INFO - PROCESS | 15389 | |7;imaging-desaturate;84;84;84;84;84;84;84;84;84;84 02:00:24 INFO - PROCESS | 15389 | |8;json-parse-financial;64;63;63;62;63;63;63;65;70;63 02:00:24 INFO - PROCESS | 15389 | |9;json-stringify-tinderbox;66;67;66;67;67;67;67;66;68;67 02:00:24 INFO - PROCESS | 15389 | |10;stanford-crypto-aes;84;83;82;86;92;82;83;83;83;82 02:00:24 INFO - PROCESS | 15389 | |11;stanford-crypto-ccm;144;140;140;141;139;141;139;137;178;138 02:00:24 INFO - PROCESS | 15389 | |12;stanford-crypto-pbkdf2;181;179;182;178;175;179;185;183;178;180 02:00:24 INFO - PROCESS | 15389 | |13;stanford-crypto-sha256-iterative;70;70;72;73;70;74;70;71;73;68 02:00:24 INFO - PROCESS | 15389 | __end_tp_report 02:00:24 INFO - PROCESS | 15389 | __start_cc_report 02:00:24 INFO - PROCESS | 15389 | _x_x_mozilla_cycle_collect,1949 02:00:24 INFO - PROCESS | 15389 | __end_cc_report 02:00:24 INFO - PROCESS | 15389 | __startTimestamp1476867624295__endTimestamp 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | ------- Summary: start ------- 02:00:24 INFO - PROCESS | 15389 | Number of tests: 14 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#0] ai-astar Cycles:10 Average:112.90 Median:114.00 stddev:3.35 (2.9%) stddev-sans-first:1.27 02:00:24 INFO - PROCESS | 15389 | Values: 104.0 114.0 116.0 112.0 114.0 114.0 114.0 114.0 112.0 115.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#1] audio-beat-detection Cycles:10 Average:138.70 Median:129.50 stddev:17.42 (13.4%) stddev-sans-first:17.02 02:00:24 INFO - PROCESS | 15389 | Values: 158.0 128.0 129.0 167.0 128.0 128.0 126.0 127.0 166.0 130.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#2] audio-dft Cycles:10 Average:161.70 Median:162.00 stddev:0.82 (0.5%) stddev-sans-first:0.87 02:00:24 INFO - PROCESS | 15389 | Values: 162.0 161.0 162.0 161.0 163.0 163.0 162.0 161.0 161.0 161.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#3] audio-fft Cycles:10 Average:82.20 Median:77.00 stddev:10.66 (13.9%) stddev-sans-first:11.07 02:00:24 INFO - PROCESS | 15389 | Values: 76.0 77.0 76.0 106.0 77.0 78.0 80.0 77.0 98.0 77.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#4] audio-oscillator Cycles:10 Average:94.40 Median:83.00 stddev:18.99 (22.9%) stddev-sans-first:19.76 02:00:24 INFO - PROCESS | 15389 | Values: 84.0 83.0 130.0 84.0 83.0 83.0 105.0 83.0 83.0 126.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 02:00:24 INFO - PROCESS | 15389 | Values: 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#6] imaging-darkroom Cycles:10 Average:146.60 Median:147.00 stddev:0.97 (0.7%) stddev-sans-first:0.88 02:00:24 INFO - PROCESS | 15389 | Values: 148.0 147.0 146.0 147.0 147.0 148.0 145.0 146.0 146.0 146.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#7] imaging-desaturate Cycles:10 Average:84.00 Median:84.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 02:00:24 INFO - PROCESS | 15389 | Values: 84.0 84.0 84.0 84.0 84.0 84.0 84.0 84.0 84.0 84.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#8] json-parse-financial Cycles:10 Average:63.90 Median:63.00 stddev:2.28 (3.6%) stddev-sans-first:2.42 02:00:24 INFO - PROCESS | 15389 | Values: 64.0 63.0 63.0 62.0 63.0 63.0 63.0 65.0 70.0 63.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#9] json-stringify-tinderbox Cycles:10 Average:66.80 Median:67.00 stddev:0.63 (0.9%) stddev-sans-first:0.60 02:00:24 INFO - PROCESS | 15389 | Values: 66.0 67.0 66.0 67.0 67.0 67.0 67.0 66.0 68.0 67.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#10] stanford-crypto-aes Cycles:10 Average:84.00 Median:83.00 stddev:3.06 (3.7%) stddev-sans-first:3.24 02:00:24 INFO - PROCESS | 15389 | Values: 84.0 83.0 82.0 86.0 92.0 82.0 83.0 83.0 83.0 82.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#11] stanford-crypto-ccm Cycles:10 Average:143.70 Median:140.50 stddev:12.20 (8.7%) stddev-sans-first:12.94 02:00:24 INFO - PROCESS | 15389 | Values: 144.0 140.0 140.0 141.0 139.0 141.0 139.0 137.0 178.0 138.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:180.00 Median:180.50 stddev:2.87 (1.6%) stddev-sans-first:3.02 02:00:24 INFO - PROCESS | 15389 | Values: 181.0 179.0 182.0 178.0 175.0 179.0 185.0 183.0 178.0 180.0 02:00:24 INFO - PROCESS | 15389 | 02:00:24 INFO - PROCESS | 15389 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.10 Median:71.50 stddev:1.85 (2.6%) stddev-sans-first:1.92 02:00:24 INFO - PROCESS | 15389 | Values: 70.0 70.0 72.0 73.0 70.0 74.0 70.0 71.0 73.0 68.0 02:00:24 INFO - PROCESS | 15389 | -------- Summary: end -------- 02:00:24 INFO - PROCESS | 15389 | 02:00:25 INFO - TEST-INFO | 15389: exit 0 02:00:25 INFO - TEST-OK | kraken | took 64782ms 02:00:25 INFO - SUITE-END | took 1187s 02:00:25 INFO - Completed test suite (00:19:47) 02:00:25 INFO - javascript benchmark 02:00:26 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2579.4067364506163, 2614.830036047658, 2636.0510216322123, 2656.1898620920624, 2665.560182569875, 4574.771261436923, 4640.373549570807, 4785.066911952171, 4797.880052998677, 4804.975975120124, 4646.883827904304, 4683.367745354376, 4724.338592597031, 4763.857084287477, 4785.712857228568, 4346.174226896896, 4376.7811609419405, 4416.514183439819, 4423.889402764925, 4434.423524941753, 4437.5340589237985, 4478.664100192498, 4480.775961201927, 4483.529229430912, 4502.189605870942, 4270.4234928284595, 4416.3596278539435, 4416.911661766747, 4432.911341773162, 4523.117991991563, 4308.202982448257, 4320.351947207912, 4373.671974601918, 4378.452693413324, 4394.4067550880545, 4360.978195109004, 4365.607095361433, 4377.102693947733, 4430.534793846664, 4433.756143412111, 4697.87268026313, 4733.83431579893, 4752.643551733599, 4773.80904763809, 4810.5670489656095, 4938.753062346904, 4992.101421744084, 4997.175466048097, 4999.825006124768, 5057.974710126463, 5069.569086627641, 5082.1360368737405, 5082.923756143661, 5132.923006154911, 5138.075146473633, 4714.316424118484, 4728.952710472851, 4733.479317275097, 4740.525947405232, 4796.112719146969, 5055.039542486916, 5138.177891537411, 5177.197534382101, 5178.533931946067, 5247.449017853147, 4923.729194894244, 4974.1543937530705, 4999.150144475448, 5006.249062640633, 5067.239914012927, 5044.394672639233, 5058.4435712071645, 5065.670731402447, 5071.290019397287, 5131.358580177478, 4986.626003049713, 5020.874478138076, 5036.949630503721, 5039.0929632666475, 5050.191969284897, 4941.1847045237855, 4953.23224900141, 5004.84985450437, 5007.924881126786, 5012.874678133076, 4336.0, 4348.108637729258, 4350.042990542076, 4395.890102747457, 4402.955970440319, 3784.6026167252594, 3789.6778773803985, 3798.1454172810895, 3815.7138214634015, 3836.9424458633143, 4268.722533035343, 4322.459692538433, 4334.5882141196535, 4339.305711086211, 4388.692791504564, 5028.547430731179, 5076.949230507722, 5079.517445842639, 5083.339165908408, 5083.415407228216, 4344.847930322424, 4345.0, 4347.087111706577, 4347.413099231627, 4355.107203023373, 4456.732596044248, 4522.34426008227, 4532.750698711537, 4538.478075021349, 4549.294859296814, 4798.880027999188, 4846.248831431134, 4855.6601037927, 4856.3201151838775, 4858.708477491362, 5116.181410974226, 5119.206522988943, 5123.820666276662, 5130.256112863689, 5182.0, 4658.440987081572, 4797.040591881568, 4800.231962885921, 4805.087033463631, 4861.7326047066335, 4955.058538877602, 4977.178765503651, 5003.224500202475, 5020.447750747488, 5030.496950304941, 5095.312132862016, 5104.2088476286235, 5106.183010718267, 5117.155669314521, 5154.046501397253, 4970.3290055842, 4973.5523802857915, 4975.402951645826, 4976.975115124401, 5031.119554078095, 4818.542238487338, 4878.56092951636, 4885.853424397274, 4896.975515122402, 4938.432080310667, 4869.220924652039, 4890.975545122252, 4894.167991441393, 4945.035718034948, 4955.603551715782, 4962.900741985212, 4967.577755890645, 4969.676970996874, 4969.8260560881645, 5028.949710502994, 4786.545278198566, 4835.6131509479865, 4853.830115945925, 4872.829450969199, 4926.4088309403105], "value": 4662.098342834548, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [573.4237091722817, 574.0700065893253, 583.6818933681146, 586.0184191479271, 588.9793857214999, 27621.447571048593, 38625.80687096564, 39680.80159599205, 39800.60199398005, 43459.0, 38865.80567097168, 39318.21363572727, 39390.40914386287, 39520.40719389211, 39532.20935581287, 7513.924860751391, 7668.578228197447, 7673.846523069536, 7675.347595454366, 7677.731279405222, 7524.2851929066655, 7583.355414789722, 7591.430642701792, 7611.048618922635, 7615.504992175519, 7598.126215485235, 7645.770626881174, 7650.120236172856, 7667.463277570572, 7671.309582137606, 7612.314891659749, 7643.847123057508, 7646.0, 7658.923410765877, 7659.770206893774, 7552.660130294095, 7593.164751877289, 7618.428617853683, 7619.695212191506, 7622.199669034782, 36645.0, 36924.0, 36969.260614787556, 36969.63030369716, 37010.8149459251, 2918.37254990176, 2928.2972086699037, 3049.817010979348, 3158.8262645554487, 3311.867525298985, 27735.861320693468, 27846.721532784617, 28397.290067748265, 28628.427431451255, 31570.0, 3330.8001519908885, 3402.0, 3422.687557238677, 3431.9485207721905, 3447.3967055765143, 250203.0, 251631.0, 251715.96568068536, 251963.0, 252738.0, 52405.213921791204, 53088.73455632774, 53113.7344313276, 53164.46835531595, 53189.542679725695, 32438.513422298685, 32469.0, 32580.185495362806, 35075.12312192216, 35114.12214694602, 15338.76991845101, 15535.45625903088, 15538.145402002772, 15541.533753987398, 15544.689106217813, 11393.601223957121, 11514.194006419637, 11521.827172592419, 11525.769484610428, 11531.88468115325, 17688.380906668463, 17730.468085957444, 17835.643287134186, 17893.7315940261, 17896.91051544734, 6624.337566243434, 6783.321667833177, 6862.142232220973, 7020.719171233196, 7133.964330178316, 784.1766145547152, 873.6854732296368, 899.8560230363111, 903.8282726281985, 910.4264313482464, 26472.941211545996, 26881.731182688312, 27389.863050685017, 27630.723692762815, 27722.44555108927, 769.5305863423307, 945.2626950978248, 956.7655924298591, 966.6520052780993, 1000.1148983149965, 13652.931735341259, 14417.0, 14523.440325385314, 14596.927015364856, 14744.41022359115, 379074.0, 382654.0, 383560.0, 383844.0, 384948.0, 49367.50632493701, 49881.50118498768, 49892.750536247084, 49969.0, 50003.999360102935, 1070.1224995503767, 1085.0885256384674, 1086.098538213281, 1131.479519421059, 1176.817593273044, 22188.556228875656, 27182.592261116493, 30492.0, 30842.383152337276, 31175.376492470477, 45096.323555146046, 45681.54318456773, 45754.54245457503, 45823.541764581925, 45830.0, 325310.0, 327233.0, 328203.0, 328400.0, 329526.0, 23881.0, 24892.75107248977, 24967.0, 24971.375715607253, 24983.250502484956, 40317.1936561273, 40411.0, 40750.184996299315, 40763.38854917238, 41253.0, 34826.12934676653, 34947.30105397827, 35133.121671957386, 35320.47019294661, 35343.0, 34525.65474345224, 34650.82674586611, 34858.65141348554, 34900.0, 35175.296494069466, 34014.319713606084, 34453.82773086119, 34585.135371615914, 34708.65291347054, 35271.470927936614, 28695.185678237565, 30495.390092197587, 30744.231394215323, 30942.69057309398, 31084.56010258147, 23849.284521464382, 24077.036918523765, 24379.39051523726, 24807.87596062008, 24873.626895596943], "value": 17049.83888408276, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [341.9195342717015, 357.6602227883511, 362.1525630025739, 363.7908202783399, 384.95957924417934, 12141.757164856708, 13209.867901320997, 15816.604584885383, 16556.420525281617, 17557.297708091693, 17304.13479326035, 17541.298348066095, 17609.855359401663, 17617.119144042812, 17724.1137943103, 4830.251311046784, 5091.185410334348, 5094.032133894567, 5149.562287205574, 5429.809956651518, 5319.707416092114, 5356.571474282048, 5359.08895487768, 5361.249425080492, 6638.1370421845095, 6947.513674042819, 6985.82535436613, 7082.575045497261, 7083.079199704057, 7094.219635840053, 6765.086713293692, 6861.210960739529, 6895.241523432418, 6899.75850845218, 7088.6810093545655, 6441.484681225491, 6658.733650653968, 6664.900026499607, 6666.799996000128, 6833.111695479556, 22347.888260558593, 22565.435864103365, 23018.0, 23115.653265201036, 23153.768462315496, 1913.6938089905686, 1919.7928854148488, 2128.7445506539316, 2219.9223027194134, 2419.903203871843, 13356.398962046731, 13964.301784910815, 14126.576202713935, 14429.783553246709, 14836.406543738238, 1767.5139336682387, 1793.8026817050113, 1796.3443343179777, 1847.3626598823384, 1890.867639265252, 80391.59804201, 82908.0, 83264.58367708123, 84208.57895710543, 84752.15247847504, 15630.374785008473, 15892.284847181905, 15904.522864314089, 15927.362905483651, 16265.593360165854, 28433.0, 28493.857530712216, 28542.0, 28555.857220713762, 28749.856250718614, 7984.710959915248, 8322.750317490485, 8420.957895210484, 8433.367497437594, 8593.140685931481, 6864.485163612749, 6869.553479023847, 7179.641017949081, 7179.784606461814, 7200.531965422231, 8006.359491240803, 8007.474842358753, 8026.799330016796, 8103.230193131761, 8129.1870812919415, 3178.825164615922, 3216.276337823971, 3267.4118658641196, 3280.7539434542505, 3291.588551431071, 330.93610463508156, 337.4044810908748, 374.5486688540302, 376.70052308414876, 747.069897977022, 10048.497575121215, 10634.521446534924, 10676.786464270826, 10767.89232107669, 11119.555217791198, 382.7952045655561, 395.64984988285573, 406.19167855967004, 408.0288912388496, 416.0140467093009, 5608.6073974821375, 5679.659220446786, 5719.0, 5798.971005145032, 5829.795957141565, 388148.0, 395911.0, 397838.0, 398582.0, 401107.0, 75008.62495687486, 76493.0, 77045.22954770493, 79579.0, 81145.59427202944, 402.94358789769456, 413.6628647652214, 413.9981245386173, 414.2791542715713, 414.75943952507475, 7939.761807145795, 9908.801823963624, 9995.950020249853, 10012.59949602037, 10164.542595583069, 35022.29955400827, 37165.0, 38683.0, 39318.0, 40109.98625171853, 50210.0, 50690.74654626703, 50794.49205508045, 51026.489735103656, 51114.48885511246, 6993.0908981832035, 7183.461240407095, 7284.817879553054, 7391.371733402721, 7513.549187048795, 9794.26543009263, 10525.631667883126, 11168.1065514757, 11281.71795705114, 11710.765784684429, 9798.608055677692, 9869.407835529892, 9973.551190196313, 10262.127719143957, 10580.985040504762, 9540.189083927944, 9572.56923438433, 9679.467629280458, 10107.545160467944, 10285.382877027403, 9855.768028996376, 9881.456519891475, 10164.745881353025, 10405.855355910693, 10465.424401657981, 7508.549487030796, 7632.5038872473115, 7649.579273140031, 7656.540607563564, 7783.260590243918, 9495.192908602847, 9656.0, 9831.459269739948, 10087.798244035224, 10335.586576536854], "value": 8250.446041261193, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1361.2717196299982, 1417.56764186923, 1495.8429364916683, 1645.3254165792014, 1715.8026826914909, 6732.52872298938, 6920.896186557193, 7500.887486687698, 8045.0, 8064.112947575769, 7369.668364923578, 7636.7708968730885, 7648.847023059536, 7778.6888524458955, 7784.805379865506, 2110.5040315525875, 2137.8931053447263, 2142.2609199826034, 2142.850000499958, 2155.493459037125, 1788.3651303787099, 1841.0058568373063, 2095.9476013099643, 2103.8842863642494, 2132.6694362373855, 2136.081484961466, 2177.0203408466173, 2177.085624037908, 2178.771229020954, 2182.8362872784523, 2090.3310940499046, 2097.727295451597, 2106.115431518758, 2124.1609564222044, 2138.315738963532, 2080.4070839810583, 2094.6648536234284, 2099.601075795594, 2104.9263275785274, 2109.0298462707174, 7845.293923546908, 7884.960575197088, 7902.960485197595, 7910.80222994424, 7921.524708517507, 4419.513853476115, 4617.907641847144, 4619.330197121399, 4627.028324051953, 4629.722216667011, 2707.742764437375, 2840.1479556133077, 2881.7406433421093, 2922.1233629910944, 2922.473954688155, 856.2165618459103, 869.3740506835069, 876.2245412809646, 891.9420237684594, 892.607252808762, 10802.621908233174, 10870.021698047134, 10878.564857405694, 10909.509072091774, 10917.672469825919, 3958.4656071430563, 4097.610726980932, 4310.137972405531, 4317.784110794448, 4318.52496225415, 9217.170454658979, 9304.25565954722, 9308.813823723487, 9317.254619630414, 9317.860232096524, 4669.509701481364, 4676.742779147112, 4677.742724150136, 4684.273937539687, 4688.9531104689195, 4146.688998325138, 4186.497620285585, 4202.474690663667, 4208.032152604918, 4212.873613791591, 3595.9101022474647, 3613.765105268149, 3686.1153323202775, 3704.073981504624, 3705.94441083384, 1025.2464438637596, 1081.0540776820283, 1161.2742036227357, 1175.5591653130077, 1180.6044974933493, 614.9385061493815, 691.6472598974559, 772.6368606754817, 780.2158830375437, 783.8432313537315, 4745.572898439157, 4807.78364973577, 4909.214525675875, 4953.0589188054155, 5006.249062640633, 830.9654480172225, 835.8411901738772, 839.5382539603194, 852.9232369086812, 876.0932434929817, 3250.5286733423995, 3329.4027883748277, 3370.8651653933566, 3392.8642854286045, 3448.3620530201993, 9094.636214551476, 9392.577334019985, 9502.382345147544, 9639.325247232626, 9639.71080867575, 9571.664991725256, 9606.039396060338, 9608.95195524018, 9613.279004074582, 9616.134547890724, 6938.779590530981, 6950.235474097845, 7036.788896333118, 7049.506534542636, 7077.150741911004, 4913.606911447004, 4965.751712414437, 5010.023045506237, 5024.773885175103, 5084.6440749147205, 8635.6977505787, 8796.076411976906, 8806.119388061143, 8841.823163536821, 8845.336599754915, 9034.864477032981, 9067.637294508146, 9131.634734610807, 9155.176034156957, 9156.633734650539, 6719.428848547928, 6833.965830170818, 6844.486663500357, 6878.7248510059035, 6879.552829066095, 7056.6471676417, 7235.746748863765, 7320.487565870338, 7570.5836179010685, 7635.847283054197, 5009.223570346602, 6300.71646775887, 6334.683265836782, 6521.478281737354, 6676.766313179015, 6063.969680151571, 6137.723802428812, 6177.96911015442, 6319.905201422074, 6364.840878977878, 5681.034224181816, 5728.369879313355, 5760.0, 5762.2221000164445, 5772.2207501986695, 4175.0, 4244.7877606118955, 4306.63393611534, 4375.103103863764, 4428.269335559726, 4147.564505726855, 4204.768737719455, 4253.27694291965, 4256.851010214627, 4282.379055037064], "value": 4022.2851293945237, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [284.94443583501214, 286.2086331293972, 294.0971218359636, 294.2995670304675, 294.62582520199345, 4863.440704319004, 4889.559939605435, 4896.681715688478, 4939.481354457784, 4948.604111671067, 4510.887227819298, 4637.953620463794, 4668.18306796311, 4747.976260118703, 4809.158397280471, 3777.3956167013284, 3785.413260944558, 3803.315403227418, 3806.276807406584, 3816.8167867960883, 3812.390017597185, 3817.141143242762, 3818.293615681094, 3839.9616003839883, 3840.347140986039, 3609.9458508122398, 3652.543432070991, 3713.9442908356395, 3736.2527494501073, 3786.488824008765, 3730.1420673245307, 3730.7575007624555, 3739.8317075731657, 3745.3071181831447, 3752.0921286003295, 3292.4732042873025, 3295.2585668224697, 3297.274599588087, 3311.9503207451908, 3313.204830840605, 4474.261746811805, 4729.385179926622, 4738.384010078667, 4748.5014073522125, 4752.334673145762, 4149.937750933738, 4206.663466922639, 4232.957670423287, 4251.91496170078, 4279.87160385189, 5029.84910452687, 5033.773480193364, 5058.620603454719, 5125.333706618153, 5137.460566640486, 3533.1873669056004, 3538.8053657048854, 3549.964500354989, 3550.2899420115823, 3575.481555174485, 5012.473690262506, 5253.212018197301, 5264.289320941701, 5306.734663266821, 5368.570514358842, 3603.4594810778594, 3608.6210947850623, 3613.2412193439145, 3619.077135330474, 3626.9637303627155, 3655.3785856404475, 3670.1742108025483, 3670.944935825965, 3685.5208822852856, 3698.223373091627, 4148.377743338463, 4164.9583504165175, 4276.5723427656985, 4277.123189746095, 4288.335308027261, 5037.222083437422, 5043.84868453947, 5056.738403729574, 5057.898842023213, 5071.644984851025, 1250.9186902851286, 1262.4950019992077, 1270.371166272701, 1271.815586739936, 1273.7579859826603, 799.2606838674203, 817.0644611919438, 836.0469065265602, 859.0807835615956, 864.9740507784651, 4430.847979525347, 4441.333799930037, 4444.955550444454, 4457.9331310030375, 4469.329600559942, 5142.280080788692, 5185.403678577012, 5195.584353251731, 5197.0, 5200.63595548308, 4303.0, 4363.170997510463, 4424.446944131983, 4435.6229720473475, 4440.311751678495, 2751.284665986858, 2753.8898444062015, 2761.254461295439, 2765.502209602251, 2771.256456108438, 4836.202026665561, 4839.927401088916, 4862.78117484714, 4866.197077482176, 4877.731724755173, 5027.371578552681, 5209.192575150858, 5213.504717051874, 5300.475184002595, 5302.92045619316, 4761.809527618856, 4777.546133117348, 4787.736674482937, 4791.616670666408, 4816.8554943351755, 5122.0, 5156.416290677943, 5164.347408829139, 5172.5603323717905, 5197.636165468532, 4916.582090522203, 5038.445770965118, 5043.268726034631, 5082.822101226439, 5082.847514574569, 4758.0, 4783.306420569068, 4791.425028996543, 4811.879703007453, 4823.855284341475, 3582.9104272392356, 3604.7837129772297, 3626.238489917147, 3626.709863210884, 3629.872954446582, 5022.924656130088, 5105.183170692671, 5134.12719837621, 5172.482751724798, 5199.220116982483, 4973.104841128632, 4975.9053008338105, 4981.651284410056, 4983.700977941335, 4988.653063672716, 4961.776720047535, 4964.0, 5005.749712514433, 5052.317937078595, 5061.974690126526, 4669.252919532859, 4873.951260487492, 4891.926621100615, 4917.680350777331, 4922.4585295616735, 4806.927896081632, 4937.185364414975, 4950.336750804451, 5050.939302746465, 5074.644774865724, 4963.9007219854675, 4968.850934471971, 4968.925466118083, 4972.577330926912, 5016.648834581691], "value": 3774.475914089982, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [597.3250227243215, 679.7722762874437, 695.3602685529313, 719.9740369972787, 720.4128635162339, 11826.231294965832, 12330.383480825967, 12339.136260461772, 12400.937995310034, 12470.314132722697, 12602.243865368084, 12752.171108877916, 12755.107142500006, 12765.80851287229, 12771.233725976424, 603.0893351039917, 753.0, 753.1978442958259, 761.0562902001534, 764.7017663111391, 639.1307821362942, 766.5362455714296, 790.2216316927821, 791.2759824760337, 797.5892415406071, 804.1194891593696, 804.3203493048394, 804.4047404920346, 804.5735760047185, 806.4959400374765, 656.7537173559915, 675.0178490296606, 794.4081659163902, 794.5868148562773, 799.2646764976207, 496.19616221720685, 496.68212344099805, 593.4273426143792, 610.1701685707434, 613.2487702564367, 12641.557545485864, 12647.49410023598, 12648.873511264861, 12656.0, 12712.237265764084, 11532.88467115335, 11735.530578776925, 11837.585684501088, 11929.642110736691, 12618.68453288666, 11422.200445968785, 11590.362530060844, 11638.476268567934, 11793.056555475541, 11849.407529623484, 3843.0968722350226, 3898.4152377143373, 3898.8440462381473, 3933.1936952924866, 3996.760194388346, 60314.69842650846, 60370.09444858331, 60375.4906127346, 60381.6980915097, 61232.0, 9487.573059212353, 9836.60653573849, 9867.210623150131, 9897.752556186153, 10057.899421005843, 18869.150888210064, 18880.62238755245, 18894.811051889305, 18897.527561811065, 18931.43205703831, 6455.548111632234, 6474.805755827333, 6541.6075035498025, 6688.230853451818, 6781.966090169616, 3366.6465021172426, 3385.830708464567, 3388.9152771180916, 3389.7627166098137, 3584.605693373727, 2662.148112603948, 2762.3646561290616, 2770.127409865886, 2772.3900741836765, 2773.88904443824, 481.0643298783902, 487.59042404379784, 498.3770287141074, 499.39323721678335, 504.4173979054198, 400.46737838675074, 463.8751028755322, 499.3957311652941, 515.3815421494147, 523.1028785632582, 6947.4789390795895, 6988.231294557595, 7143.678534465961, 7160.928390716131, 7473.140588832354, 507.92635067914944, 526.3920172201114, 528.2393353570923, 533.226821109393, 548.2954403591366, 3442.6557344265875, 3455.706264967456, 3628.8729894454095, 3631.5823680276576, 3714.68425183857, 95355.0, 97277.0, 99353.0, 102292.0, 102371.0, 84857.0, 85665.88948008251, 86183.0, 87555.56222218848, 87862.56068719615, 50321.748391258545, 61624.69187654033, 62249.06626400608, 74675.05199168215, 79517.0, 8043.758687239392, 8263.586820658822, 8300.767151384045, 8519.105493923296, 8520.275776559061, 33307.83346083254, 34763.0, 40886.0, 41123.532588044814, 43630.56369436265, 56033.439665602826, 59488.405115948284, 60799.69600151971, 60907.0, 64456.35543644503, 10668.359898406121, 11821.82267266009, 12001.279923204636, 12421.31682757457, 13046.478140874258, 12270.447829847857, 12525.123241373016, 12583.811242831182, 12957.416916238602, 13049.28228947417, 11107.055900248246, 11223.158263130135, 11583.189176757545, 12322.199057061262, 12342.75314493723, 11085.347143261402, 11599.246049006788, 11868.238895265964, 12003.0, 12375.133740638068, 11203.383813889988, 11318.32090074598, 11350.375729334635, 11470.0, 11677.708057298636, 9503.429794212369, 9508.239340852853, 9768.26737994639, 10094.14199793026, 10154.289199755945, 9038.909610903807, 9389.624415023323, 9413.0, 9415.608672480948, 9426.198773104363], "value": 6337.617584571169, "unit": "score"}], "name": "dromaeo_css", "value": 6309.778095190816, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 114.0, 116.0, 112.0, 114.0, 114.0, 114.0, 114.0, 112.0, 115.0], "value": 112.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 128.0, 129.0, 167.0, 128.0, 128.0, 126.0, 127.0, 166.0, 130.0], "value": 138.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 161.0, 162.0, 161.0, 163.0, 163.0, 162.0, 161.0, 161.0, 161.0], "value": 161.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 76.0, 106.0, 77.0, 78.0, 80.0, 77.0, 98.0, 77.0], "value": 82.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 130.0, 84.0, 83.0, 83.0, 105.0, 83.0, 83.0, 126.0], "value": 94.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 146.0, 147.0, 147.0, 148.0, 145.0, 146.0, 146.0, 146.0], "value": 146.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 84.0, 84.0, 84.0, 84.0, 84.0, 84.0, 84.0, 84.0], "value": 84.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 63.0, 63.0, 62.0, 63.0, 63.0, 63.0, 65.0, 70.0, 63.0], "value": 63.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 66.0, 67.0, 67.0, 67.0, 67.0, 66.0, 68.0, 67.0], "value": 66.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 82.0, 86.0, 92.0, 82.0, 83.0, 83.0, 83.0, 82.0], "value": 84.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 140.0, 140.0, 141.0, 139.0, 141.0, 139.0, 137.0, 178.0, 138.0], "value": 143.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [181.0, 179.0, 182.0, 178.0, 175.0, 179.0, 185.0, 183.0, 178.0, 180.0], "value": 180.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 70.0, 72.0, 73.0, 70.0, 74.0, 70.0, 71.0, 73.0, 68.0], "value": 71.1, "unit": "score"}], "name": "kraken", "value": 1547.0, "alertThreshold": 2.0}]} 02:00:26 INFO - Return code: 0 02:00:26 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 02:00:26 INFO - # TBPL SUCCESS # 02:00:26 INFO - Running post-action listener: _resource_record_post_action 02:00:26 INFO - [mozharness: 2016-10-19 09:00:26.095420Z] Finished run-tests step (success) 02:00:26 INFO - Running post-run listener: _resource_record_post_run 02:00:26 INFO - Total resource usage - Wall time: 1204s; CPU: 13.0%; Read bytes: 0; Write bytes: 390402048; Read time: 0; Write time: 267852 02:00:26 INFO - TinderboxPrint: CPU usage
13.0% 02:00:26 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 02:00:26 INFO - TinderboxPrint: I/O write bytes / time
390,402,048 / 267,852 02:00:26 INFO - TinderboxPrint: CPU idle
8,354.6 (87.0%) 02:00:26 INFO - TinderboxPrint: CPU user
1,202.3 (12.5%) 02:00:26 INFO - TinderboxPrint: Swap in / out
0 / 0 02:00:26 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 99618816; Read time: 0; Write time: 83912 02:00:26 INFO - run-tests - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 290783232; Read time: 0; Write time: 183940 02:00:26 INFO - Running post-run listener: _upload_blobber_files 02:00:26 INFO - Blob upload gear active. 02:00:26 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 02:00:26 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 02:00:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 02:00:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 02:00:27 INFO - (blobuploader) - INFO - Open directory for files ... 02:00:27 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 02:00:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:00:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:00:27 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 02:00:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:00:27 INFO - (blobuploader) - INFO - Done attempting. 02:00:27 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 02:00:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:00:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:00:31 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 02:00:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:00:31 INFO - (blobuploader) - INFO - Done attempting. 02:00:31 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 02:00:31 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:00:31 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:00:31 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 02:00:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:00:31 INFO - (blobuploader) - INFO - Done attempting. 02:00:31 INFO - (blobuploader) - INFO - Iteration through files over. 02:00:31 INFO - Return code: 0 02:00:31 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 02:00:31 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 02:00:31 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/ea0b59f8ed1e1a1e0aa286167ce6d99967ab1e6993d77f947978054ca00fd27013e7916f4eaefef3d01cb4efbde63df2db67dc33adcd7c6baeeedbf87ce8d3bf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d9ab836e39898d1d8f05e9bcc6667d248938b9c6db546f674f4a09127c9edd5eb11dc947fc8bf3ac0a4cfa35776506549e82a26825ec3e339aded85d944ec85d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/967e3035dba5952d4831f93080edcdcf1353b3b9c15b91d1a9ebf881c70c8d50222fb7d664ae882ba85b93a0c4180ffa8d8e6fead05a500b6151b0755fdaf1d7"} 02:00:31 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 02:00:31 INFO - Writing to file /builds/slave/test/properties/blobber_files 02:00:31 INFO - Contents: 02:00:31 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/ea0b59f8ed1e1a1e0aa286167ce6d99967ab1e6993d77f947978054ca00fd27013e7916f4eaefef3d01cb4efbde63df2db67dc33adcd7c6baeeedbf87ce8d3bf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d9ab836e39898d1d8f05e9bcc6667d248938b9c6db546f674f4a09127c9edd5eb11dc947fc8bf3ac0a4cfa35776506549e82a26825ec3e339aded85d944ec85d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/967e3035dba5952d4831f93080edcdcf1353b3b9c15b91d1a9ebf881c70c8d50222fb7d664ae882ba85b93a0c4180ffa8d8e6fead05a500b6151b0755fdaf1d7"} 02:00:31 INFO - Running post-run listener: copy_logs_to_upload_dir 02:00:31 INFO - Copying logs to upload dir... 02:00:31 INFO - mkdir: /builds/slave/test/build/upload/logs 02:00:31 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1246.331138 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-10-19 02:00:31.475821) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-19 02:00:31.480519) ========= 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=4300f881736b422476174874000001bc-1476866383.846336-1371870119 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/ea0b59f8ed1e1a1e0aa286167ce6d99967ab1e6993d77f947978054ca00fd27013e7916f4eaefef3d01cb4efbde63df2db67dc33adcd7c6baeeedbf87ce8d3bf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d9ab836e39898d1d8f05e9bcc6667d248938b9c6db546f674f4a09127c9edd5eb11dc947fc8bf3ac0a4cfa35776506549e82a26825ec3e339aded85d944ec85d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/967e3035dba5952d4831f93080edcdcf1353b3b9c15b91d1a9ebf881c70c8d50222fb7d664ae882ba85b93a0c4180ffa8d8e6fead05a500b6151b0755fdaf1d7"} build_url:https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011417 build_url: 'https://queue.taskcluster.net/v1/task/Y0GFyeTsSvSeILvUR9wUjw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/ea0b59f8ed1e1a1e0aa286167ce6d99967ab1e6993d77f947978054ca00fd27013e7916f4eaefef3d01cb4efbde63df2db67dc33adcd7c6baeeedbf87ce8d3bf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/d9ab836e39898d1d8f05e9bcc6667d248938b9c6db546f674f4a09127c9edd5eb11dc947fc8bf3ac0a4cfa35776506549e82a26825ec3e339aded85d944ec85d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/967e3035dba5952d4831f93080edcdcf1353b3b9c15b91d1a9ebf881c70c8d50222fb7d664ae882ba85b93a0c4180ffa8d8e6fead05a500b6151b0755fdaf1d7"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-19 02:00:31.505623) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 02:00:31.505931) ========= 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=4300f881736b422476174874000001bc-1476866383.846336-1371870119 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004479 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-19 02:00:31.587880) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-19 02:00:31.588198) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-19 02:00:31.588502) ========= ========= Total master_lag: 0.17 =========