builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-041 starttime: 1474572178.44 results: success (0) buildid: 20160922103000 builduid: de2a861d9b864c779dceccffa2978081 revision: 46645a6bb7dc88603beb3ce3e55fd63a1d2fc75b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.439996) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.440490) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.440783) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.494100) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.494634) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-22 12:22:59-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 218M=0s 2016-09-22 12:22:59 (218 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.153630 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.663511) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.663871) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018783 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.715625) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:58.716033) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 46645a6bb7dc88603beb3ce3e55fd63a1d2fc75b --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 46645a6bb7dc88603beb3ce3e55fd63a1d2fc75b --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=8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-22 12:22:59,373 truncating revision to first 12 chars 2016-09-22 12:22:59,373 Setting DEBUG logging. 2016-09-22 12:22:59,373 attempt 1/10 2016-09-22 12:22:59,373 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/46645a6bb7dc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-22 12:22:59,776 unpacking tar archive at: fx-team-46645a6bb7dc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.757669 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:59.487417) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:59.487755) ========= script_repo_revision: 46645a6bb7dc88603beb3ce3e55fd63a1d2fc75b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:59.488181) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:59.488461) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-22 12:22:59.497348) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 44 secs) (at 2016-09-22 12:22:59.497764) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:23:00 INFO - MultiFileLogger online at 20160922 12:23:00 in /builds/slave/test 12:23:00 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --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 12:23:00 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:23:00 INFO - {'append_to_log': False, 12:23:00 INFO - 'base_work_dir': '/builds/slave/test', 12:23:00 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 12:23:00 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:23:00 INFO - 'branch': 'Fx-Team-Non-PGO', 12:23:00 INFO - 'buildbot_json_path': 'buildprops.json', 12:23:00 INFO - 'config_files': ('talos/linux_config.py',), 12:23:00 INFO - 'default_actions': ('clobber', 12:23:00 INFO - 'read-buildbot-config', 12:23:00 INFO - 'download-and-extract', 12:23:00 INFO - 'populate-webroot', 12:23:00 INFO - 'create-virtualenv', 12:23:00 INFO - 'install', 12:23:00 INFO - 'run-tests'), 12:23:00 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:23:00 INFO - 'download_minidump_stackwalk': True, 12:23:00 INFO - 'download_symbols': 'ondemand', 12:23:00 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:23:00 INFO - 'tooltool.py': '/tools/tooltool.py', 12:23:00 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:23:00 INFO - '/tools/misc-python/virtualenv.py')}, 12:23:00 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:23:00 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:23:00 INFO - 'installer_path': 'installer.exe', 12:23:00 INFO - 'log_level': 'info', 12:23:00 INFO - 'log_name': 'talos', 12:23:00 INFO - 'log_to_console': True, 12:23:00 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:23:00 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:23:00 INFO - 'opt_config_files': (), 12:23:00 INFO - 'pip_index': False, 12:23:00 INFO - 'sps_profile': False, 12:23:00 INFO - 'sps_profile_interval': 0, 12:23:00 INFO - 'suite': 'dromaeojs-e10s', 12:23:00 INFO - 'system_bits': '32', 12:23:00 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:23:00 INFO - 'title': 'talos-linux64-ix-041', 12:23:00 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:23:00 INFO - 'use_talos_json': True, 12:23:00 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:23:00 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:23:00 INFO - 'work_dir': 'build'} 12:23:00 INFO - [mozharness: 2016-09-22 19:23:00.250383Z] Running clobber step. 12:23:00 INFO - Running pre-action listener: _resource_record_pre_action 12:23:00 INFO - Running main action method: clobber 12:23:00 INFO - rmtree: /builds/slave/test/build 12:23:00 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:23:00 INFO - Running post-action listener: _resource_record_post_action 12:23:00 INFO - [mozharness: 2016-09-22 19:23:00.713818Z] Finished clobber step (success) 12:23:00 INFO - [mozharness: 2016-09-22 19:23:00.713920Z] Running read-buildbot-config step. 12:23:00 INFO - Running pre-action listener: _resource_record_pre_action 12:23:00 INFO - Running main action method: read_buildbot_config 12:23:00 INFO - Using buildbot properties: 12:23:00 INFO - { 12:23:00 INFO - "project": "", 12:23:00 INFO - "product": "firefox", 12:23:00 INFO - "script_repo_revision": "production", 12:23:00 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 12:23:00 INFO - "repository": "", 12:23:00 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 12:23:00 INFO - "buildid": "20160922103000", 12:23:00 INFO - "pgo_build": "False", 12:23:00 INFO - "basedir": "/builds/slave/test", 12:23:00 INFO - "buildnumber": 1612, 12:23:00 INFO - "slavename": "talos-linux64-ix-041", 12:23:00 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 12:23:00 INFO - "platform": "ubuntu64_hw", 12:23:00 INFO - "scheduler": "tests-fx-team-linux64-talos-8-3600", 12:23:00 INFO - "branch": "fx-team", 12:23:00 INFO - "repo_path": "integration/fx-team", 12:23:00 INFO - "revision": "46645a6bb7dc88603beb3ce3e55fd63a1d2fc75b", 12:23:00 INFO - "stage_platform": "linux64", 12:23:00 INFO - "builduid": "de2a861d9b864c779dceccffa2978081", 12:23:00 INFO - "slavebuilddir": "test" 12:23:00 INFO - } 12:23:00 INFO - Found installer url https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 12:23:00 INFO - Running post-action listener: _resource_record_post_action 12:23:00 INFO - [mozharness: 2016-09-22 19:23:00.716390Z] Finished read-buildbot-config step (success) 12:23:00 INFO - [mozharness: 2016-09-22 19:23:00.716479Z] Running download-and-extract step. 12:23:00 INFO - Running pre-action listener: _resource_record_pre_action 12:23:00 INFO - Running main action method: download_and_extract 12:23:00 INFO - mkdir: /builds/slave/test/build/tests 12:23:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:00 INFO - trying https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 12:23:00 INFO - Downloading https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/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 12:23:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/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 12:23:01 INFO - Downloaded 1361 bytes. 12:23:01 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 12:23:01 INFO - Using the following test package requirements: 12:23:01 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 12:23:01 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:23:01 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:23:01 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'jsshell-linux-x86_64.zip'], 12:23:01 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:23:01 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 12:23:01 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:23:01 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:23:01 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:23:01 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:23:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:23:01 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:23:01 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 12:23:01 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:23:01 INFO - Fetch https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 12:23:01 INFO - Expected file size: 20373210 12:23:06 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 12:23:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 12:23:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:23:06 INFO - Fetch https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 12:23:06 INFO - Expected file size: 20373210 12:23:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 12:23:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:23:11 INFO - Fetch https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 12:23:11 INFO - Expected file size: 14414059 12:23:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:12 INFO - trying https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:23:12 INFO - Downloading https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/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 12:23:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/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 12:23:13 INFO - Downloaded 55708676 bytes. 12:23:13 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:23:13 INFO - mkdir: /builds/slave/test/properties 12:23:13 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:23:13 INFO - Writing to file /builds/slave/test/properties/build_url 12:23:13 INFO - Contents: 12:23:13 INFO - build_url:https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:23:14 INFO - Running post-action listener: _resource_record_post_action 12:23:14 INFO - Running post-action listener: set_extra_try_arguments 12:23:14 INFO - [mozharness: 2016-09-22 19:23:14.262971Z] Finished download-and-extract step (success) 12:23:14 INFO - [mozharness: 2016-09-22 19:23:14.263201Z] Running populate-webroot step. 12:23:14 INFO - Running pre-action listener: _resource_record_pre_action 12:23:14 INFO - Running main action method: populate_webroot 12:23:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:23:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:23:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:23:14 INFO - '--tppagecycles', 12:23:14 INFO - '7'], 12:23:14 INFO - 'tests': ['tsvgm']}}, 12:23:14 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:23:14 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:23:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:23:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:23:14 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:23:14 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:23:14 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['damp', 'tps']}, 12:23:14 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'tests': ['damp', 'tps']}, 12:23:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['dromaeo_dom']}, 12:23:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:23:14 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['basic_compositor_video']}, 12:23:14 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 12:23:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['a11yr', 12:23:14 INFO - 'ts_paint', 12:23:14 INFO - 'tpaint', 12:23:14 INFO - 'sessionrestore', 12:23:14 INFO - 'sessionrestore_no_auto_restore', 12:23:14 INFO - 'tabpaint']}, 12:23:14 INFO - 'other-e10s': {'tests': ['a11yr', 12:23:14 INFO - 'ts_paint', 12:23:14 INFO - 'tpaint', 12:23:14 INFO - 'sessionrestore', 12:23:14 INFO - 'sessionrestore_no_auto_restore', 12:23:14 INFO - 'tabpaint']}, 12:23:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:23:14 INFO - 'ts_paint', 12:23:14 INFO - 'tpaint', 12:23:14 INFO - 'sessionrestore', 12:23:14 INFO - 'sessionrestore_no_auto_restore', 12:23:14 INFO - 'tabpaint']}, 12:23:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:23:14 INFO - 'ts_paint', 12:23:14 INFO - 'tpaint', 12:23:14 INFO - 'sessionrestore', 12:23:14 INFO - 'sessionrestore_no_auto_restore', 12:23:14 INFO - 'tabpaint']}, 12:23:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['a11yr', 12:23:14 INFO - 'ts_paint', 12:23:14 INFO - 'tpaint', 12:23:14 INFO - 'sessionrestore', 12:23:14 INFO - 'sessionrestore_no_auto_restore', 12:23:14 INFO - 'tabpaint']}, 12:23:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['a11yr', 12:23:14 INFO - 'ts_paint', 12:23:14 INFO - 'tpaint', 12:23:14 INFO - 'sessionrestore', 12:23:14 INFO - 'sessionrestore_no_auto_restore', 12:23:14 INFO - 'tabpaint']}, 12:23:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['tsvgx', 12:23:14 INFO - 'tsvgr_opacity', 12:23:14 INFO - 'tart', 12:23:14 INFO - 'tscrollx', 12:23:14 INFO - 'cart']}, 12:23:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:23:14 INFO - 'tsvgr_opacity', 12:23:14 INFO - 'tart', 12:23:14 INFO - 'tscrollx', 12:23:14 INFO - 'cart']}, 12:23:14 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'talos_options': ['--disable-e10s'], 12:23:14 INFO - 'tests': ['tp5o']}, 12:23:14 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'tests': ['tp5o']}, 12:23:14 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'talos_options': ['--disable-e10s', 12:23:14 INFO - '--xperf_path', 12:23:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:23:14 INFO - 'tests': ['tp5n']}, 12:23:14 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:23:14 INFO - 'talos_options': ['--xperf_path', 12:23:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:23:14 INFO - 'tests': ['tp5n']}}, 12:23:14 INFO - 'talos.zip': {'path': '', 12:23:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:23:14 INFO - Running post-action listener: _resource_record_post_action 12:23:14 INFO - [mozharness: 2016-09-22 19:23:14.284510Z] Finished populate-webroot step (success) 12:23:14 INFO - [mozharness: 2016-09-22 19:23:14.284598Z] Running create-virtualenv step. 12:23:14 INFO - Running pre-action listener: _resource_record_pre_action 12:23:14 INFO - Running main action method: create_virtualenv 12:23:14 INFO - Creating virtualenv /builds/slave/test/build/venv 12:23:14 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 12:23:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:23:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:23:14 INFO - Using real prefix '/usr' 12:23:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:23:14 INFO - Installing distribute.............................................................................................................................................................................................done. 12:23:16 INFO - Installing pip.................done. 12:23:16 INFO - Return code: 0 12:23:16 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:23:16 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')]} 12:23:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:16 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')]} 12:23:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:16 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:16 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 12:23:16 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 12:23:16 INFO - Using env: {'DISPLAY': ':0', 12:23:16 INFO - 'HOME': '/home/cltbld', 12:23:16 INFO - 'LANG': 'en_US.UTF-8', 12:23:16 INFO - 'LANGUAGE': 'en_US:en', 12:23:16 INFO - 'LOGNAME': 'cltbld', 12:23:16 INFO - 'MAIL': '/var/mail/cltbld', 12:23:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:16 INFO - 'MOZ_NO_REMOTE': '1', 12:23:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:16 INFO - 'NO_EM_RESTART': '1', 12:23:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:16 INFO - 'PWD': '/builds/slave/test', 12:23:16 INFO - 'SHELL': '/bin/bash', 12:23:16 INFO - 'SHLVL': '1', 12:23:16 INFO - 'TERM': 'linux', 12:23:16 INFO - 'TMOUT': '86400', 12:23:16 INFO - 'USER': 'cltbld', 12:23:16 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:16 INFO - '_': '/tools/buildbot/bin/python'} 12:23:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:17 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 12:23:17 INFO - Cleaning up... 12:23:17 INFO - Return code: 0 12:23:17 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:23: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')]} 12:23:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23: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')]} 12:23:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:17 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:17 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 12:23:17 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 12:23:17 INFO - Using env: {'DISPLAY': ':0', 12:23:17 INFO - 'HOME': '/home/cltbld', 12:23:17 INFO - 'LANG': 'en_US.UTF-8', 12:23:17 INFO - 'LANGUAGE': 'en_US:en', 12:23:17 INFO - 'LOGNAME': 'cltbld', 12:23:17 INFO - 'MAIL': '/var/mail/cltbld', 12:23:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:17 INFO - 'MOZ_NO_REMOTE': '1', 12:23:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:17 INFO - 'NO_EM_RESTART': '1', 12:23:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:17 INFO - 'PWD': '/builds/slave/test', 12:23:17 INFO - 'SHELL': '/bin/bash', 12:23:17 INFO - 'SHLVL': '1', 12:23:17 INFO - 'TERM': 'linux', 12:23:17 INFO - 'TMOUT': '86400', 12:23:17 INFO - 'USER': 'cltbld', 12:23:17 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:17 INFO - '_': '/tools/buildbot/bin/python'} 12:23:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:17 INFO - Downloading/unpacking psutil>=3.1.1 12:23:17 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 12:23:17 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 12:23:17 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 12:23:17 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 12:23:17 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 12:23:17 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 12:23:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:23:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:23:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:23:19 INFO - Installing collected packages: psutil 12:23:19 INFO - Running setup.py install for psutil 12:23:19 INFO - building 'psutil._psutil_linux' extension 12:23:19 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 12:23:19 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 12:23:19 INFO - building 'psutil._psutil_posix' extension 12:23:19 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 12:23:19 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 12:23:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:23:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:23:19 INFO - Successfully installed psutil 12:23:19 INFO - Cleaning up... 12:23:20 INFO - Return code: 0 12:23:20 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:23:20 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')]} 12:23:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:20 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')]} 12:23:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:20 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:20 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 12:23:20 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 12:23:20 INFO - Using env: {'DISPLAY': ':0', 12:23:20 INFO - 'HOME': '/home/cltbld', 12:23:20 INFO - 'LANG': 'en_US.UTF-8', 12:23:20 INFO - 'LANGUAGE': 'en_US:en', 12:23:20 INFO - 'LOGNAME': 'cltbld', 12:23:20 INFO - 'MAIL': '/var/mail/cltbld', 12:23:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:20 INFO - 'MOZ_NO_REMOTE': '1', 12:23:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:20 INFO - 'NO_EM_RESTART': '1', 12:23:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:20 INFO - 'PWD': '/builds/slave/test', 12:23:20 INFO - 'SHELL': '/bin/bash', 12:23:20 INFO - 'SHLVL': '1', 12:23:20 INFO - 'TERM': 'linux', 12:23:20 INFO - 'TMOUT': '86400', 12:23:20 INFO - 'USER': 'cltbld', 12:23:20 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:20 INFO - '_': '/tools/buildbot/bin/python'} 12:23:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:20 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:23:20 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 12:23:20 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 12:23:20 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 12:23:20 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 12:23:20 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 12:23:20 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 12:23:22 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:23:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:23:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:23:22 INFO - Installing collected packages: mozsystemmonitor 12:23:22 INFO - Running setup.py install for mozsystemmonitor 12:23:22 INFO - Successfully installed mozsystemmonitor 12:23:22 INFO - Cleaning up... 12:23:22 INFO - Return code: 0 12:23:22 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:23:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:22 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:22 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 12:23:22 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 12:23:22 INFO - Using env: {'DISPLAY': ':0', 12:23:22 INFO - 'HOME': '/home/cltbld', 12:23:22 INFO - 'LANG': 'en_US.UTF-8', 12:23:22 INFO - 'LANGUAGE': 'en_US:en', 12:23:22 INFO - 'LOGNAME': 'cltbld', 12:23:22 INFO - 'MAIL': '/var/mail/cltbld', 12:23:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:22 INFO - 'MOZ_NO_REMOTE': '1', 12:23:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:22 INFO - 'NO_EM_RESTART': '1', 12:23:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:22 INFO - 'PWD': '/builds/slave/test', 12:23:22 INFO - 'SHELL': '/bin/bash', 12:23:22 INFO - 'SHLVL': '1', 12:23:22 INFO - 'TERM': 'linux', 12:23:22 INFO - 'TMOUT': '86400', 12:23:22 INFO - 'USER': 'cltbld', 12:23:22 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:22 INFO - '_': '/tools/buildbot/bin/python'} 12:23:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:22 INFO - Downloading/unpacking jsonschema==2.5.1 12:23:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:23:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:23:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:23:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:23:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:23:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:23:24 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:23:24 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:23:24 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 12:23:24 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 12:23:24 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 12:23:24 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 12:23:24 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 12:23:24 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 12:23:24 INFO - Downloading functools32-3.2.3-2.tar.gz 12:23:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:23:24 INFO - warning: no files found matching '*.txt' 12:23:24 INFO - no previously-included directories found matching 'build' 12:23:24 INFO - no previously-included directories found matching 'dist' 12:23:24 INFO - no previously-included directories found matching '.git*' 12:23:24 INFO - Installing collected packages: jsonschema, functools32 12:23:24 INFO - Running setup.py install for functools32 12:23:24 INFO - warning: no files found matching '*.txt' 12:23:24 INFO - no previously-included directories found matching 'build' 12:23:24 INFO - no previously-included directories found matching 'dist' 12:23:24 INFO - no previously-included directories found matching '.git*' 12:23:24 INFO - Successfully installed jsonschema functools32 12:23:24 INFO - Cleaning up... 12:23:24 INFO - Return code: 0 12:23:24 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 12:23:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:24 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:24 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 12:23:24 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 12:23:24 INFO - Using env: {'DISPLAY': ':0', 12:23:24 INFO - 'HOME': '/home/cltbld', 12:23:24 INFO - 'LANG': 'en_US.UTF-8', 12:23:24 INFO - 'LANGUAGE': 'en_US:en', 12:23:24 INFO - 'LOGNAME': 'cltbld', 12:23:24 INFO - 'MAIL': '/var/mail/cltbld', 12:23:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:24 INFO - 'MOZ_NO_REMOTE': '1', 12:23:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:24 INFO - 'NO_EM_RESTART': '1', 12:23:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:24 INFO - 'PWD': '/builds/slave/test', 12:23:24 INFO - 'SHELL': '/bin/bash', 12:23:24 INFO - 'SHLVL': '1', 12:23:24 INFO - 'TERM': 'linux', 12:23:24 INFO - 'TMOUT': '86400', 12:23:24 INFO - 'USER': 'cltbld', 12:23:24 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:24 INFO - '_': '/tools/buildbot/bin/python'} 12:23:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:25 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 12:23:25 INFO - Cleaning up... 12:23:25 INFO - Return code: 0 12:23:25 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:23:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 12:23:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 12:23:25 INFO - Using env: {'DISPLAY': ':0', 12:23:25 INFO - 'HOME': '/home/cltbld', 12:23:25 INFO - 'LANG': 'en_US.UTF-8', 12:23:25 INFO - 'LANGUAGE': 'en_US:en', 12:23:25 INFO - 'LOGNAME': 'cltbld', 12:23:25 INFO - 'MAIL': '/var/mail/cltbld', 12:23:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:25 INFO - 'MOZ_NO_REMOTE': '1', 12:23:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:25 INFO - 'NO_EM_RESTART': '1', 12:23:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:25 INFO - 'PWD': '/builds/slave/test', 12:23:25 INFO - 'SHELL': '/bin/bash', 12:23:25 INFO - 'SHLVL': '1', 12:23:25 INFO - 'TERM': 'linux', 12:23:25 INFO - 'TMOUT': '86400', 12:23:25 INFO - 'USER': 'cltbld', 12:23:25 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:25 INFO - '_': '/tools/buildbot/bin/python'} 12:23:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:25 INFO - Downloading/unpacking blobuploader==1.2.4 12:23:25 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 12:23:25 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 12:23:25 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 12:23:25 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 12:23:25 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 12:23:25 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 12:23:27 INFO - Downloading blobuploader-1.2.4.tar.gz 12:23:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:23:27 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:23:27 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 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 12:23:27 INFO - Downloading docopt-0.6.1.tar.gz 12:23:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:23:27 INFO - Installing collected packages: blobuploader, requests, docopt 12:23:27 INFO - Running setup.py install for blobuploader 12:23:28 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:23:28 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:23:28 INFO - Running setup.py install for requests 12:23:28 INFO - Running setup.py install for docopt 12:23:28 INFO - Successfully installed blobuploader requests docopt 12:23:28 INFO - Cleaning up... 12:23:28 INFO - Return code: 0 12:23:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:23:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:28 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:28 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 12:23:28 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 12:23:28 INFO - Using env: {'DISPLAY': ':0', 12:23:28 INFO - 'HOME': '/home/cltbld', 12:23:28 INFO - 'LANG': 'en_US.UTF-8', 12:23:28 INFO - 'LANGUAGE': 'en_US:en', 12:23:28 INFO - 'LOGNAME': 'cltbld', 12:23:28 INFO - 'MAIL': '/var/mail/cltbld', 12:23:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:28 INFO - 'MOZ_NO_REMOTE': '1', 12:23:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:28 INFO - 'NO_EM_RESTART': '1', 12:23:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:28 INFO - 'PWD': '/builds/slave/test', 12:23:28 INFO - 'SHELL': '/bin/bash', 12:23:28 INFO - 'SHLVL': '1', 12:23:28 INFO - 'TERM': 'linux', 12:23:28 INFO - 'TMOUT': '86400', 12:23:28 INFO - 'USER': 'cltbld', 12:23:28 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:28 INFO - '_': '/tools/buildbot/bin/python'} 12:23:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:23:28 INFO - Running setup.py (path:/tmp/pip-sVqFcB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:23:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:23:28 INFO - Running setup.py (path:/tmp/pip-97Q2jb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:23:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:23:28 INFO - Running setup.py (path:/tmp/pip-TxhnaV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:23:29 INFO - Running setup.py (path:/tmp/pip-ofGQxf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:23:29 INFO - Running setup.py (path:/tmp/pip-r2Gk68-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:23:29 INFO - Running setup.py (path:/tmp/pip-F2_QdD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:23:29 INFO - Running setup.py (path:/tmp/pip-iqcNjl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:23:29 INFO - Running setup.py (path:/tmp/pip-2yBfp9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:23:29 INFO - Running setup.py (path:/tmp/pip-ZfR2BW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:23:29 INFO - Running setup.py (path:/tmp/pip-r8dgT8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:23:29 INFO - Running setup.py (path:/tmp/pip-L_oxKg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:23:29 INFO - Running setup.py (path:/tmp/pip-RQFcVJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:23:29 INFO - Running setup.py (path:/tmp/pip-EuiBsS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:23:29 INFO - Running setup.py (path:/tmp/pip-DVjpWr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:23:29 INFO - Running setup.py (path:/tmp/pip-OVJEh9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:23:29 INFO - Running setup.py (path:/tmp/pip-6AilJd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:23:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:23:29 INFO - Running setup.py (path:/tmp/pip-WNO6Mh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:23:30 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:23:30 INFO - Running setup.py install for manifestparser 12:23:30 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Running setup.py install for mozcrash 12:23:30 INFO - Running setup.py install for mozdebug 12:23:30 INFO - Running setup.py install for mozdevice 12:23:30 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Running setup.py install for mozfile 12:23:30 INFO - Running setup.py install for mozhttpd 12:23:30 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Running setup.py install for mozinfo 12:23:30 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Running setup.py install for mozInstall 12:23:30 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:23:30 INFO - Running setup.py install for mozleak 12:23:30 INFO - Running setup.py install for mozlog 12:23:31 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:23:31 INFO - Running setup.py install for moznetwork 12:23:31 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:23:31 INFO - Running setup.py install for mozprocess 12:23:31 INFO - Running setup.py install for mozprofile 12:23:31 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:23:31 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:23:31 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:23:31 INFO - Running setup.py install for mozrunner 12:23:31 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:23:31 INFO - Running setup.py install for mozscreenshot 12:23:31 INFO - Running setup.py install for moztest 12:23:31 INFO - Running setup.py install for mozversion 12:23:31 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:23:31 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:23:31 INFO - Cleaning up... 12:23:31 INFO - Return code: 0 12:23:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:23:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:23:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:31 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:31 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 12:23:31 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 12:23:31 INFO - Using env: {'DISPLAY': ':0', 12:23:31 INFO - 'HOME': '/home/cltbld', 12:23:31 INFO - 'LANG': 'en_US.UTF-8', 12:23:31 INFO - 'LANGUAGE': 'en_US:en', 12:23:31 INFO - 'LOGNAME': 'cltbld', 12:23:31 INFO - 'MAIL': '/var/mail/cltbld', 12:23:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:31 INFO - 'MOZ_NO_REMOTE': '1', 12:23:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:31 INFO - 'NO_EM_RESTART': '1', 12:23:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:31 INFO - 'PWD': '/builds/slave/test', 12:23:31 INFO - 'SHELL': '/bin/bash', 12:23:31 INFO - 'SHLVL': '1', 12:23:31 INFO - 'TERM': 'linux', 12:23:31 INFO - 'TMOUT': '86400', 12:23:31 INFO - 'USER': 'cltbld', 12:23:31 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:31 INFO - '_': '/tools/buildbot/bin/python'} 12:23:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:23:32 INFO - Running setup.py (path:/tmp/pip-WiFcWg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:23:32 INFO - Running setup.py (path:/tmp/pip-B5L591-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:23:32 INFO - Running setup.py (path:/tmp/pip-_bLFl0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:23:32 INFO - Running setup.py (path:/tmp/pip-78uh5A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:23:32 INFO - Running setup.py (path:/tmp/pip-JxANqg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:23:32 INFO - Running setup.py (path:/tmp/pip-gk8d09-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:23:32 INFO - Running setup.py (path:/tmp/pip-Q5S3sn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:23:32 INFO - Running setup.py (path:/tmp/pip-bcKAXN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:23:32 INFO - Running setup.py (path:/tmp/pip-IZfyOE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:23:32 INFO - Running setup.py (path:/tmp/pip-L4LwnM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:23:32 INFO - Running setup.py (path:/tmp/pip-Q4Kv3e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:23:32 INFO - Running setup.py (path:/tmp/pip-qNPRfG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:23:32 INFO - Running setup.py (path:/tmp/pip-jXFopQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:23:32 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)) 12:23:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:23:32 INFO - Running setup.py (path:/tmp/pip-TX7gGU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:23:33 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)) 12:23:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:23:33 INFO - Running setup.py (path:/tmp/pip-CDmW3I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:23:33 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)) 12:23:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:23:33 INFO - Running setup.py (path:/tmp/pip-QESas8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:23:33 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)) 12:23:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:23:33 INFO - Running setup.py (path:/tmp/pip-S2ygTz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:23:33 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)) 12:23:33 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)) 12:23:33 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)) 12:23:33 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)) 12:23:33 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)) 12:23:33 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)) 12:23:33 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:23:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:23:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:23:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:23:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:23:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:23:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:23:35 INFO - Downloading blessings-1.6.tar.gz 12:23:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:23:35 INFO - Installing collected packages: blessings 12:23:35 INFO - Running setup.py install for blessings 12:23:35 INFO - Successfully installed blessings 12:23:35 INFO - Cleaning up... 12:23:35 INFO - Return code: 0 12:23:35 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:23:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:23:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:23:35 INFO - Reading from file tmpfile_stdout 12:23:35 INFO - Current package versions: 12:23:35 INFO - argparse == 1.2.1 12:23:35 INFO - blessings == 1.6 12:23:35 INFO - blobuploader == 1.2.4 12:23:35 INFO - docopt == 0.6.1 12:23:35 INFO - functools32 == 3.2.3-2 12:23:35 INFO - jsonschema == 2.5.1 12:23:35 INFO - manifestparser == 1.1 12:23:35 INFO - mozInstall == 1.12 12:23:35 INFO - mozcrash == 0.17 12:23:35 INFO - mozdebug == 0.1 12:23:35 INFO - mozdevice == 0.48 12:23:35 INFO - mozfile == 1.2 12:23:35 INFO - mozhttpd == 0.7 12:23:35 INFO - mozinfo == 0.9 12:23:35 INFO - mozleak == 0.1 12:23:35 INFO - mozlog == 3.4 12:23:35 INFO - moznetwork == 0.27 12:23:35 INFO - mozprocess == 0.23 12:23:35 INFO - mozprofile == 0.28 12:23:35 INFO - mozrunner == 6.12 12:23:35 INFO - mozscreenshot == 0.1 12:23:35 INFO - mozsystemmonitor == 0.3 12:23:35 INFO - moztest == 0.7 12:23:35 INFO - mozversion == 1.4 12:23:35 INFO - psutil == 3.1.1 12:23:35 INFO - requests == 1.2.3 12:23:35 INFO - wsgiref == 0.1.2 12:23:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:23:35 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')]} 12:23:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:35 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')]} 12:23:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:35 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:35 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 12:23:35 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 12:23:35 INFO - Using env: {'DISPLAY': ':0', 12:23:35 INFO - 'HOME': '/home/cltbld', 12:23:35 INFO - 'LANG': 'en_US.UTF-8', 12:23:35 INFO - 'LANGUAGE': 'en_US:en', 12:23:35 INFO - 'LOGNAME': 'cltbld', 12:23:35 INFO - 'MAIL': '/var/mail/cltbld', 12:23:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:35 INFO - 'MOZ_NO_REMOTE': '1', 12:23:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:35 INFO - 'NO_EM_RESTART': '1', 12:23:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:35 INFO - 'PWD': '/builds/slave/test', 12:23:35 INFO - 'SHELL': '/bin/bash', 12:23:35 INFO - 'SHLVL': '1', 12:23:35 INFO - 'TERM': 'linux', 12:23:35 INFO - 'TMOUT': '86400', 12:23:35 INFO - 'USER': 'cltbld', 12:23:35 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:35 INFO - '_': '/tools/buildbot/bin/python'} 12:23:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 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)) 12:23:35 INFO - Cleaning up... 12:23:35 INFO - Return code: 0 12:23:35 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:23:35 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')]} 12:23:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:23:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:35 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')]} 12:23:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:23:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:23:35 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 0x7fa90d7a2f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a4c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b19ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', '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 12:23:35 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 12:23:35 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 12:23:35 INFO - Using env: {'DISPLAY': ':0', 12:23:35 INFO - 'HOME': '/home/cltbld', 12:23:35 INFO - 'LANG': 'en_US.UTF-8', 12:23:35 INFO - 'LANGUAGE': 'en_US:en', 12:23:35 INFO - 'LOGNAME': 'cltbld', 12:23:35 INFO - 'MAIL': '/var/mail/cltbld', 12:23:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:35 INFO - 'MOZ_NO_REMOTE': '1', 12:23:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:35 INFO - 'NO_EM_RESTART': '1', 12:23:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:35 INFO - 'PWD': '/builds/slave/test', 12:23:35 INFO - 'SHELL': '/bin/bash', 12:23:35 INFO - 'SHLVL': '1', 12:23:35 INFO - 'TERM': 'linux', 12:23:35 INFO - 'TMOUT': '86400', 12:23:35 INFO - 'USER': 'cltbld', 12:23:35 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:35 INFO - '_': '/tools/buildbot/bin/python'} 12:23:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:23:36 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:23:36 INFO - Cleaning up... 12:23:36 INFO - Return code: 0 12:23:36 INFO - Running post-action listener: _resource_record_post_action 12:23:36 INFO - Running post-action listener: _start_resource_monitoring 12:23:36 INFO - Starting resource monitoring. 12:23:36 INFO - [mozharness: 2016-09-22 19:23:36.074260Z] Finished create-virtualenv step (success) 12:23:36 INFO - [mozharness: 2016-09-22 19:23:36.074716Z] Running install step. 12:23:36 INFO - Running pre-action listener: _resource_record_pre_action 12:23:36 INFO - Running main action method: install 12:23:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:23:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:23:36 INFO - Reading from file tmpfile_stdout 12:23:36 INFO - Detecting whether we're running mozinstall >=1.0... 12:23:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:23:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:23:36 INFO - Reading from file tmpfile_stdout 12:23:36 INFO - Output received: 12:23:36 INFO - Usage: mozinstall [options] installer 12:23:36 INFO - Options: 12:23:36 INFO - -h, --help show this help message and exit 12:23:36 INFO - -d DEST, --destination=DEST 12:23:36 INFO - Directory to install application into. [default: 12:23:36 INFO - "/builds/slave/test"] 12:23:36 INFO - --app=APP Application being installed. [default: firefox] 12:23:36 INFO - mkdir: /builds/slave/test/build/application 12:23:36 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'] 12:23:36 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 12:23:52 INFO - Reading from file tmpfile_stdout 12:23:52 INFO - Output received: 12:23:52 INFO - /builds/slave/test/build/application/firefox/firefox 12:23:52 INFO - Running post-action listener: _resource_record_post_action 12:23:52 INFO - [mozharness: 2016-09-22 19:23:52.459536Z] Finished install step (success) 12:23:52 INFO - [mozharness: 2016-09-22 19:23:52.459781Z] Running run-tests step. 12:23:52 INFO - Running pre-action listener: _resource_record_pre_action 12:23:52 INFO - Running main action method: run_tests 12:23:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:23:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:23:52 INFO - Python 2.7.3 12:23:52 INFO - Return code: 0 12:23:52 INFO - grabbing minidump binary from tooltool 12:23:52 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')]} 12:23:52 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 0x2b16f60>, '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 0x2b17d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2b181d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:23:52 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 12:23:52 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 12:23:52 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 12:23:52 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:23:52 INFO - Return code: 0 12:23:52 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:23:52 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:23:52 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:23:52 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:23:52 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:23:52 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-041', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 12:23:52 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-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-041 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 12:23:52 INFO - Using env: {'DISPLAY': ':0', 12:23:52 INFO - 'HOME': '/home/cltbld', 12:23:52 INFO - 'LANG': 'en_US.UTF-8', 12:23:52 INFO - 'LANGUAGE': 'en_US:en', 12:23:52 INFO - 'LOGNAME': 'cltbld', 12:23:52 INFO - 'MAIL': '/var/mail/cltbld', 12:23:52 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:23:52 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:23:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:23:52 INFO - 'MOZ_NO_REMOTE': '1', 12:23:52 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:23:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:23:52 INFO - 'NO_EM_RESTART': '1', 12:23:52 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:23:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:23:52 INFO - 'PWD': '/builds/slave/test', 12:23:52 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:23:52 INFO - 'SHELL': '/bin/bash', 12:23:52 INFO - 'SHLVL': '1', 12:23:52 INFO - 'TERM': 'linux', 12:23:52 INFO - 'TMOUT': '86400', 12:23:52 INFO - 'USER': 'cltbld', 12:23:52 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533', 12:23:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:23:52 INFO - '_': '/tools/buildbot/bin/python'} 12:23:52 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-041', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 12:23:52 INFO - mozversion application_buildid: 20160922103000 12:23:52 INFO - mozversion application_changeset: 46645a6bb7dc88603beb3ce3e55fd63a1d2fc75b 12:23:52 INFO - mozversion application_display_name: Nightly 12:23:52 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:23:52 INFO - mozversion application_name: Firefox 12:23:52 INFO - mozversion application_remotingname: firefox 12:23:52 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 12:23:52 INFO - mozversion application_vendor: Mozilla 12:23:52 INFO - mozversion application_version: 52.0a1 12:23:52 INFO - mozversion platform_buildid: 20160922103000 12:23:52 INFO - mozversion platform_changeset: 46645a6bb7dc88603beb3ce3e55fd63a1d2fc75b 12:23:52 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 12:23:52 INFO - mozversion platform_version: 52.0a1 12:23:52 INFO - using testdate: 1474572232 12:23:52 INFO - actual date: 1474572232 12:23:52 INFO - starting webserver on 'localhost:35833' 12:23:52 INFO - SUITE-START | Running 2 tests 12:23:52 INFO - TEST-START | dromaeo_css 12:23:52 INFO - operating with platform_type : linux_ 12:23:52 INFO - Initialising browser for dromaeo_css test... 12:23:52 INFO - TEST-INFO | started process 22852 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpptOuLR/profile http://localhost:35833/getInfo.html) 12:23:57 INFO - PROCESS | 22852 | __metrics Screen width/height:1600/1200 12:23:57 INFO - PROCESS | 22852 | colorDepth:24 12:23:57 INFO - PROCESS | 22852 | Browser inner width/height: 1024/697 12:23:57 INFO - PROCESS | 22852 | __metrics 12:23:58 ERROR - PROCESS | 22852 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3067: TypeError: this.tabs is undefined 12:23:59 INFO - TEST-INFO | 22852: exit 0 12:23:59 INFO - Browser initialized. 12:23:59 INFO - Running cycle 1/1 for dromaeo_css test... 12:23:59 INFO - TEST-INFO | started process 22974 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpptOuLR/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:24:11 INFO - PROCESS | 22974 | RSS: Main: 185835520 12:24:11 INFO - PROCESS | 22974 | 12:25:01 INFO - PROCESS | 22974 | 1474572301284 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] 12:27:14 INFO - PROCESS | 22974 | Cycle 1(1): loaded http://localhost:35833/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35833/tests/dromaeo/cssquery-ext.html) 12:27:15 INFO - PROCESS | 22974 | RSS: Main: 200380416 12:27:15 INFO - PROCESS | 22974 | 12:30:17 INFO - PROCESS | 22974 | Cycle 1(1): loaded http://localhost:35833/tests/dromaeo/cssquery-ext.html (next: http://localhost:35833/tests/dromaeo/cssquery-jquery.html) 12:30:18 INFO - PROCESS | 22974 | RSS: Main: 196562944 12:30:18 INFO - PROCESS | 22974 | 12:33:20 INFO - PROCESS | 22974 | Cycle 1(1): loaded http://localhost:35833/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35833/tests/dromaeo/cssquery-mootools.html) 12:33:20 INFO - PROCESS | 22974 | RSS: Main: 198840320 12:33:20 INFO - PROCESS | 22974 | 12:36:22 INFO - PROCESS | 22974 | Cycle 1(1): loaded http://localhost:35833/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35833/tests/dromaeo/cssquery-prototype.html) 12:36:23 INFO - PROCESS | 22974 | RSS: Main: 195350528 12:36:23 INFO - PROCESS | 22974 | 12:39:26 INFO - PROCESS | 22974 | Cycle 1(1): loaded http://localhost:35833/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35833/tests/dromaeo/cssquery-yui.html) 12:39:27 INFO - PROCESS | 22974 | RSS: Main: 198705152 12:39:27 INFO - PROCESS | 22974 | 12:42:29 INFO - PROCESS | 22974 | Cycle 1(1): loaded http://localhost:35833/tests/dromaeo/cssquery-yui.html (next: http://localhost:35833/tests/dromaeo/cssquery-dojo.html) 12:42:30 INFO - PROCESS | 22974 | RSS: Main: 199376896 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | __start_tp_report 12:42:30 INFO - PROCESS | 22974 | _x_x_mozilla_page_load 12:42:30 INFO - PROCESS | 22974 | _x_x_mozilla_page_load_details 12:42:30 INFO - PROCESS | 22974 | |i|pagename|runs| 12:42:30 INFO - PROCESS | 22974 | |0;dojo.html;2628.9999999999995;2643.4316621926296;2652.7877769778415;2668.6664166979126;2672.3319170207446;4567;4676.1349150407195;4741.2651039089;4747.572718455338;4827.25177597473;4640.976795116028;4663.883402914928;4688.273317635763;4694.342792009122;4702.529747025295;4317.827286908519;4356.586124318184;4404.163208990281;4425.203463376591;4474.798634061459;4184.602462766033;4264.4882614086355;4339.305711086226;4370.759608221562;4381.430414046185;4242.7030107892615;4320.546342634041;4351.042770590465;4356.542563030868;4425.734455932655;4353.695241333108;4363.600366273189;4384.539623339535;4394.648428125743;4440.311751678495;4086.162336720965;4352.7823608819435;4353.869383918487;4360.803763830635;4391.538888416702;4560.338750881137;4576.588107070346;4642.930356044662;4663.48701642819;4722.220833562458;4942.061008408391;4954.900901981976;4965.131102057126;4971.867211247144;5028.044671512401;5005.124103281947;5007.273945277951;5009.524095210949;5011.173156429185;5078.542931136216;4580.679352445331;4625.861224163281;4648.48866624671;4675.4155730533685;4685.835995740133;5138.460461651547;5140.280360749498;5157.484251574812;5170.741462926839;5209.218617207373;4929.975350123226;4944.184209605375;4946.060248552763;4948.777305021283;5005.899882002413;4885.438174609894;4926.359573255454;4960.751962401865;4983.127952608279;5014.648974571818;4970.502949705001;4973.079980203674;4988.35151430319;5031.823886163967;5046.293518907356;4854.417469903634;4904.779284932187;4936.48166942473;4948.208286674115;5001.8499445016705;4185.686073544496;4233.576642335742;4276.764777937181;4308.9353659695125;4330.978345108254;3742.176721121349;3750.624937506282;3758.7368884177845;3798.2783271178387;3807.428885667172;4374.03771170342;4416.24923762961;4433.490148632884;4437.511873693891;4439.822407103679;4884.242942343943;4884.7313397762755;4996.625253105959;5046.1673823818655;5061.595072394273;4383.298672212431;4401.537838526972;4423.867283981485;4432.889177770581;4445.26653102241;4587.42657167854;4599.471060827981;4601.470830854428;4604.401427814362;4659.976700116477;4619;4705.600023997861;4743.620510359094;4804.975975120102;4810.63920205993;5058.848234552969;5103.413107492686;5115.360579927509;5131.332926719502;5154.845354639367;4800.159972004955;4801.375821143229;4810.6632535722165;4814.494478079751;4867.026594681007;4835.734034628129;4880.95119048805;5009.9248511271635;5021.84934451967;5071.594272458268;4935.580475659609;4991.126552853164;5000.849974500771;5011.123053465702;5046.47012063728;4873.829415970424;4884.853454396374;4887.43794463627;4896.730679812502;4955.157623204136;4774.498677638798;4881.145799485005;4923.975380123076;4930.6795058321095;4938.48145944685;4761.714297142183;4808.3989501312335;4843.75781210931;4901.41183058021;4996.175631020841;5004.42449118356;5012.523810238022;5019.422766381913;5021.84934451967;5040.294358789845;4702.553257440538;4770.522947705202;4918.311436398835;4920.015996800726;4923.65534412602 12:42:30 INFO - PROCESS | 22974 | |1;ext.html;526.7550588976126;529.9496547827956;543.3344153412071;548.23247453565;551.495381725721;38730.41904371433;40388.39417408738;40631.98420039497;43520.347194792026;43530;38824.611753882455;39238.411423828664;39346.40980385296;39441.605583944154;39720.40419393704;7687.846243075149;7837.921620783776;7847.097583777853;7856.332211762007;7859.803504912395;7430.962845185766;7475.2524747525085;7482.775516734507;7543.283388078124;7551.622418879034;7506.324430801227;7560.659770310322;7567.470277080606;7582.393408527305;7594.772156835304;7503.512271702322;7523.962380188092;7540.095188577351;7547.735829246005;7577.128630207541;7550.9622451887935;7593.962030189814;7634.50375725576;7640.044994375703;7649.349805266559;37122.62877371219;37403.81298093492;37698.81150594257;37756.622433775585;37809;2932.9853350733324;2947.2042548511995;2986.0146151769864;3114.299282661406;3288.391647545212;27378.315542111406;27885.302867428272;28094.43811123766;28405.289867753265;29717.55423668647;3415.829208539588;3455.4125798614295;3480.547528821237;3500.2124521982605;3512.8067956262394;246850;247706;248946;249911;250191;50361.496385036415;50679.74660126676;50707;50798.49201508011;50866.23700644419;31248;32033.679663203537;32260.19349516281;33751.662483375345;34029.65970340265;13787.655308617364;13861.86138138626;13915.791263131061;13939;13958.58124256274;10488.68533943983;10553.894461055444;10609.204309676805;10619.84070238947;10622.044016038593;17242.913785431243;17406.825931740776;17439.389621363192;17446.738298925527;17470.56323591895;6626.734930602818;6821.420179284717;6888.41448476885;6979.651017449107;7079.39825114871;751.2262369759156;853.50923219148;861.3109512390063;884.7788052986754;905.8188362327561;26238;27483.450330993666;27976.160715178576;27985;28093.43813123726;818.4557269415891;925.4586067150658;936.2463217110155;948.4972964328916;985.5515740338129;14197.345804852594;14412.279386030657;14561.344739486749;14624.561263162122;14703.117812931258;333561;334783;335077;336944;338290;45793;46306.76846615745;46379.53620463752;46715.29927051097;46866.5313346869;1150.5685367987005;1157.8784227656142;1182.698411904976;1183.4319526627096;1186.768580126867;24764.38089047788;25495.490090198462;26633.733662663126;26759.331016724736;26919.865400672872;39966.600333996284;40424.595754042086;40445.39331909965;40457.797711011255;40549;305600;306537;306906;307448;311228;24233.273001809976;24621.38446538851;24909.252722418358;24911;24929;39943.60056399515;40549.39175912305;41009.794951025055;41106;41343.37984930168;35082.47376289307;35158.29683406266;35398.646013540565;35434.11414714653;35970.640293597775;34985.475217871244;35024.29951401009;35137.824310878284;35225.64774352223;35264.64735352614;26892.193234203005;34649.653503464644;34736;35006;35524.11189720174;25261;30070.548941765453;31670;31785.523217151298;31924.45548662565;24394.146204882745;24728.25815225546;24934;24936.127235546668;25059.49881002333 12:42:30 INFO - PROCESS | 22974 | |2;jquery.html;353.45920741265854;363.3115246607678;369.8187887934911;372.42274474564454;385.3622255167697;15301.464448744282;16427.34290628375;16848.32606695732;16856.747148792747;16887.746683799753;15141.848581514181;16438.917805410987;16601.916990415062;16832;16850.578735531617;4926.261060840867;5192.844214673566;5193.714345710984;5202.115640341132;5203.583713302945;3642.7996460194677;3834.118152824838;5097.949020509803;5663.773449062032;5935.703214839263;6002.8499287517725;6011.158437818709;6011.639301641915;6012.038073908176;6017.7592896284095;5782.3639399666;5965.522758179357;5976.193213916109;6000.969995150018;6004.519638428916;5111.2333150027425;5257.316548848664;5263.131583288753;5266.262723218752;5275.261463395128;19752.209911603517;20031.09860056301;20070.297539586045;20078;20106.899465502724;1937.7577802774654;1951.2097600471832;1984.5931584025384;2011.688188330811;2506.6490691303234;12773;12890.80663790044;13061.412236449383;13378;13729.176249425067;1677.1278934953878;1689.1976311252179;1703.4123227486498;1705.6077102266547;1756.6398888228011;65629.67185164092;67561.66219168872;67943.3205667942;68464;70474.64762676154;9274.95362523183;9309.30180236485;9633.90366096344;9829.066238707312;9896.140505202977;13000.934995324962;13096.934515327554;13143.934280328729;13283.136596121221;13353.799693004612;6358.809235722936;6579.605223686498;6716.83207919806;6882.5870447773295;6905.482088843357;5808.767649293981;5902.675352855548;5983.790567330123;6127.356627554132;6127.908081378783;5790.10253410722;5846.1230815377185;5880.441358070976;5913.615614985099;6012.458878700938;1612.6371566397702;1669.348953907977;1695.4913525942168;1737.7654016707584;1823.5988082621802;821.5317269156643;836.8284501677142;846.5132548784474;872.5637181409295;913.7304495173939;15910.12494312824;15935.840641593668;16309.83690163107;16521.9260748051;16803.831961680473;842.6839935024366;851.9829603408022;880.3221519430003;885.818407226517;906.5421961909194;9221.90778092224;9640.035996400444;9666.516674166263;9695.806083878424;9840.212782977345;323175;325896;342562;344079;346153;64991;68000;68288.31711682919;69720.6513967437;69729.65135174291;887.942283751567;893.5219657483216;913.5980168725739;918.5177781664679;925.0194793518891;14696;14839;14856;15203.467878624195;15316.693666126392;33228.50157247692;33831.32337353288;35324.82337588296;35832;40398.79800600978;49308.50691493039;49632.50367496279;50173;50547;50653.24020139775;5102.69383836971;7357.963210183915;7494.213107623621;7567.281108294703;7649.31156195945;9652.420854748738;11731.706707332385;11858.644240672793;12074.879251207376;12156.93921530422;10091;10098.697039088838;10099.495025248561;10415.218858585486;10642.148628109888;9840.163586094975;10178.440185789557;10258.58965641366;10389;10498.370097794157;10367.32612380193;10385.688429347132;10565.20760942917;10820.56717731282;10858.891411086104;6428.517861160525;6570.638614876228;6726.260111387645;7375.741849035258;7575.924240757522;9653.565589548627;10548.472576370998;10552.525136369035;10739.838902416626;11100.333979961228 12:42:30 INFO - PROCESS | 22974 | |3;mootools.html;1337.6054064051107;1362.4550179928028;1435.885129189665;1609.476920001;1639.4262008297098;6470.579412338195;6683.766068187614;7133.643317834107;7753.457257991943;7753.651085701143;7336.633168341588;7662.272084151997;7664.770056898302;7667.5782831944225;7669;2088.3943656339643;2099.8110170084688;2114.3339847947923;2115.957680846382;2117.830573554112;2107.589020141073;2128.3082998025625;2132.136484723682;2149.6668016457475;2161.859479133859;2122.840786940978;2137.9893100534478;2139.2833400810746;2147.8281737460966;2151.634222182225;2097.2345094040716;2097.97199372308;2101.6112019276484;2117.047328702075;2123;2030.3299911029326;2065.163608738463;2070.782567830371;2072.9481762955897;2075.9169633214806;7605.5436673799195;7655.846883062308;7660.348870346027;7665.156832748393;7672.884906726348;4250.171216612762;4377.212101821671;4384.517703052662;4398.208322501949;4454.13144436835;2819.7180281971846;2871.684114747376;2911.30128769096;2938.030449951511;2939.9706002940125;878.7875842090468;908.1418059933366;911.1890417528405;926.7729406295433;927.3493182135742;10123.79752404955;10166.694999150037;10215.080642742114;10217.080462758313;10236.334638248565;3726.347889119393;3975.383815508601;4017.196560687874;4043.6360727534075;4066.3290557057753;8661.263792577702;8688;8694.91305086941;8704.173103555278;8706.085860984505;4465.955340446554;4484.327350897392;4484.798184081724;4489.775511224426;4492.303692927601;3489.45913383426;3622.7464077514846;3789.5831458539537;4101.241270364992;4106.178764247163;3418.8973781124428;3535.116220944764;3601.603823579404;3635.1457407509215;3749.775013499199;1098.3849044535086;1120.5405783628673;1123.337231033694;1125.926814757038;1127.0420142878488;662.8806814773387;715.7494876793185;791.1455627921831;817.9918200817916;839.7774589733725;4836.226203807374;4874.4150701916;4945.851624451272;5029.673071250357;5158.561522270574;370.75344895644093;382.829640809837;383.2297082863409;383.56656977615114;389.0371330955918;3424.434968230264;3454.5854497460464;3779.8643766271966;3897.707671924617;3934.5475270344277;9015.729528114036;9135.634574617074;9169.724908252763;9196.816063678689;9245.352825302165;9080.8637870432;9083.545822708971;9114.680986165453;9187.127222913812;9220.90779092214;6573.769918052845;6875.518713689994;6940.583564986117;7099.3965512930945;7151.427885769126;5145.71698556568;5146.511081447256;5184.170532714747;5280.867978300574;5537.6954267515675;7951.165127661744;8337.916620833957;8396.454230475;8422.536760477988;8427.95786021066;8325.292350150305;8362.540060296498;8387.790305242417;8512.531810750468;8533.487990720576;5811.622244554091;5994.790182343597;6310.49516038725;6405.295417504164;6409.8718025640155;6880.415164711056;7104.076470058859;7154.105736782903;7318.926810731825;7323.6338183089565;6395.360463953567;6460.935390646221;6540.869182616226;6582.407583317525;6746.4265537429865;6172.135900973777;6251.9687401562705;6276.717547710273;6283.842903927255;6288.779892703734;5914.881702365842;6044.365341639064;6044.879102418015;6051.697415129138;6074.939250607614;4451.755153466591;4453.309736990772;4485.147821913826;4533.730555444481;4539.863804085882;4364.8472303469225;4404.119176164716;4409.735415875058;4417.182821178092;4419.558044195554 12:42:30 INFO - PROCESS | 22974 | |4;prototype.html;279.30035261669514;281.8125946245747;288.1801275371567;289.247955316178;290.35251389401634;5022;5050.595952323814;5085.389753229613;5091.669041512299;5098;4955.653104282702;4961.776720047597;4967.379077615298;4967.652264341497;4968.850934471971;3632.418812989922;3694.150345420555;3740.756850804689;3817.0838998640406;3832;3811.6569508744205;3818.1409182933758;3822.694184465236;3823.541175058997;3856.11309398837;3819.197968426634;3828.119532507525;3828.9808550957346;3832.2527107214105;3837.884863454101;3522.903872196039;3725.2549490102087;3829.751066180689;3848.326542855003;3877.651011408987;3217.4047801156626;3217.7264932480534;3219.3561287742546;3228.386606544749;3238.4656531672244;4809.0763694522475;4832.661713680044;4844.442889067767;4845.6123510119105;4873.269009648581;4261.914761704779;4272.423222864935;4277.657787377002;4278.935815962763;4312.698111132222;4998.10034193845;5095.261187127883;5097.745112744385;5145.3568303962;5160.535551800319;3491.3715531204375;3504.8598056077726;3523.453864650983;3529.3117842020815;3553.8223088845452;5405.270313499682;5428.321459817523;5486.670799752028;5496.835094947118;5523.6685798852195;3593.1017245688577;3619.149499867529;3657.579378371468;3670.944935825965;3705.2589482103685;3698.815059247027;3699.7595156314756;3706.7405281630568;3730.738848280594;3734.6452087051684;4320.719153255091;4321.6974811762875;4327.6105150536605;4337.8481753138485;4341.218580655449;4864.881077352158;5220.399654039758;5241.42344342122;5247.711375874287;5256.369235691742;1260.6659235302468;1294.1199984010964;1295.352323838081;1295.591888555121;1295.598364506987;780.6292011294703;797.8204903896577;804.6459557794552;805.255138996426;808.8261023879894;4542.568455996675;4677;4694.483606803249;4705.482396936334;4715.339852420664;5441.6261917610545;5466.289382380344;5472.425395333512;5474.810075969564;5497.422770609109;4579.546846295162;4633.582977532038;4671.27595222741;4677.929831052537;4689.132510485571;2837.52448726661;2858.185417156142;2870.827750334945;2887.566864970271;2899.739023487854;5077.949220507748;5115.38615366151;5123.89836185222;5146;5167.560757335594;5200.855811721415;5429.809956651498;5442.9722005715485;5467.5625949923915;5488.643238189505;5062.82280120194;5067.7837319043165;5117.283580298761;5129.717275812302;5135.845924622267;5383.173833737163;5400;5401.810936617199;5403.216533602685;5404.513593776579;5017.498250175099;5278.445763194963;5287.68273903567;5324.227986941949;5375.193720941734;5160.612954028538;5165.192182736012;5177.611679124006;5186.291801362045;5186.870328241824;3733.6639702425828;3742.9812850935573;3766.981165094157;3769.4345848123003;3791;5153.587712983027;5355.464453554613;5440.483154100354;5496.917546236729;5520.558355331644;5221.347331583552;5231.189165679326;5240.5807535397835;5241.895162096813;5261.237120617412;5236.371635403776;5261.6579922306455;5267.473252674855;5270.156774915995;5281.287026251407;5067.949320506747;5099.439061703136;5121;5130.255313407459;5145;5003.749812509433;5143.3570803649545;5158.148905430562;5225.529702326809;5277.261183434399;5150.6137039721425;5154.587632989427;5156.587473002076;5167.457416971314;5173.706573356661 12:42:30 INFO - PROCESS | 22974 | |5;yui.html;580.0776764943738;588.361627634017;610.41095342994;708.6385943168982;715.7244460882561;11952.402379881003;12941.611751647453;12985.805212921814;12997.090203685746;13039.087263891519;11870.109741769358;12000.939995300034;12073.21524100935;12091.334976576285;12174.756504869898;707.9256678048808;728.6320408193855;729.0704351951251;730.7040648537325;731.1993367262866;718.8706032914073;749.3480671815528;753.0850017229066;756.5233902641356;757.1066141952493;775.0273406874364;779.185750890321;780.4185881518276;781.5584194929846;783.0212234706617;771.2827070824131;772.2162005564356;772.3242163107253;773.9883901741479;778.0274656679151;568.5139205978911;570.3640440908357;571.4628249445508;571.6312978129125;572.9684867332295;12828.166169198972;12902.612921612366;12912.870871291354;12913.096083274175;12928.48286068556;13920.37358318878;14138.222397768119;14332.42670293187;14499;14526.201058941753;11194.720131996684;11233.382163980978;11258.099352051899;11326.377049262288;11870.169088163831;3212.534182543518;3287.8849240276477;3344.8996530104137;3350.882719104844;3353.446681297583;65145.67427162881;65658.3434165657;65724.3427565723;66292.6685366575;67055;10531.631392901212;10599.258051936291;10669.253152279265;10710.410927398912;10793;19174.61650766977;19484.51288717765;19489.415317540213;19619.411417657495;19621;6881.724731010703;6918.688659010357;6921.7356648234345;7145.321194486515;7270.563766174047;3807.7144214184045;3908;3916.2950668879307;3953.920921581552;3961.3067713150085;2834.9858250708617;2921.2258751430886;2939.6325459317586;2949.0857834071508;2950.0559820857547;482.68143025602933;490.5021403275678;490.872373182975;493.88146844757;498.89772596617604;459.4830815332751;490.0419679526517;516.8191133103384;523.9554637855749;536.5064140990298;7739.148693643695;7872.409569282212;8111.269985701198;8237.711680091288;8252.504849709037;514.9433562308143;521.3665396543219;523.1028785632658;529.9284596579489;543.4782608695697;3620.9094772630897;3623.4021386470936;3751.9812400938367;3813.8093095345675;4047.1096358801015;56944;57161.71419142878;59077.40922590719;104302.47848760708;104630;84180.15819841724;85513;86163;86549.56725216334;89437.55281223552;48314.75842620764;57293.713531432906;76365.5635496404;76898.23101769022;79308;6784.423324017514;6902.309769023058;6993.125859267591;7012.859742805013;7310.415166786751;36981;37630.435543467414;38221.61778382181;47422;48021.5197848031;37819.432708508844;39936.60063399329;40038.39942400808;42555.7872210637;58779.061046948336;11113.333200008025;11572.768544628892;11589.6523104307;11606.361650108987;11629.24409913353;12098.395080246128;12610.49558017669;12787.61637150887;12857.549985750828;12965.870341296466;12365.38173091324;12620.747585048432;12640.747185056063;12686.809697854724;12871.742565148832;11038;11200.663980080612;11394.658160255205;11725.589604363806;12568.245905245714;11546.884531154581;11569.942150289195;11988.460519276829;12071.939640301742;12436.19164754288;9549.761255968657;9940.403575785476;9973.351732137387;10089.394636321844;10211.489425528842;8778.604962776562;9465;10327.122194613241;10416.32293900894;10471.581136754749 12:42:30 INFO - PROCESS | 22974 | __end_tp_report 12:42:30 INFO - PROCESS | 22974 | __start_cc_report 12:42:30 INFO - PROCESS | 22974 | _x_x_mozilla_cycle_collect,366 12:42:30 INFO - PROCESS | 22974 | __end_cc_report 12:42:30 INFO - PROCESS | 22974 | __startTimestamp1474573350029__endTimestamp 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | ------- Summary: start ------- 12:42:30 INFO - PROCESS | 22974 | Number of tests: 6 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | [#0] dojo.html Cycles:165 Average:4656.55 Median:4801.38 stddev:474.44 (9.9%) stddev-sans-first:448.44 12:42:30 INFO - PROCESS | 22974 | Values: 2629.0 2643.4 2652.8 2668.7 2672.3 4567.0 4676.1 4741.3 4747.6 4827.3 4641.0 4663.9 4688.3 4694.3 4702.5 4317.8 4356.6 4404.2 4425.2 4474.8 4184.6 4264.5 4339.3 4370.8 4381.4 4242.7 4320.5 4351.0 4356.5 4425.7 4353.7 4363.6 4384.5 4394.6 4440.3 4086.2 4352.8 4353.9 4360.8 4391.5 4560.3 4576.6 4642.9 4663.5 4722.2 4942.1 4954.9 4965.1 4971.9 5028.0 5005.1 5007.3 5009.5 5011.2 5078.5 4580.7 4625.9 4648.5 4675.4 4685.8 5138.5 5140.3 5157.5 5170.7 5209.2 4930.0 4944.2 4946.1 4948.8 5005.9 4885.4 4926.4 4960.8 4983.1 5014.6 4970.5 4973.1 4988.4 5031.8 5046.3 4854.4 4904.8 4936.5 4948.2 5001.8 4185.7 4233.6 4276.8 4308.9 4331.0 3742.2 3750.6 3758.7 3798.3 3807.4 4374.0 4416.2 4433.5 4437.5 4439.8 4884.2 4884.7 4996.6 5046.2 5061.6 4383.3 4401.5 4423.9 4432.9 4445.3 4587.4 4599.5 4601.5 4604.4 4660.0 4619.0 4705.6 4743.6 4805.0 4810.6 5058.8 5103.4 5115.4 5131.3 5154.8 4800.2 4801.4 4810.7 4814.5 4867.0 4835.7 4881.0 5009.9 5021.8 5071.6 4935.6 4991.1 5000.8 5011.1 5046.5 4873.8 4884.9 4887.4 4896.7 4955.2 4774.5 4881.1 4924.0 4930.7 4938.5 4761.7 4808.4 4843.8 4901.4 4996.2 5004.4 5012.5 5019.4 5021.8 5040.3 4702.6 4770.5 4918.3 4920.0 4923.7 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | [#1] ext.html Cycles:180 Average:44388.28 Median:19297.64 stddev:78599.64 (407.3%) stddev-sans-first:78751.14 12:42:30 INFO - PROCESS | 22974 | Values: 526.8 529.9 543.3 548.2 551.5 38730.4 40388.4 40632.0 43520.3 43530.0 38824.6 39238.4 39346.4 39441.6 39720.4 7687.8 7837.9 7847.1 7856.3 7859.8 7431.0 7475.3 7482.8 7543.3 7551.6 7506.3 7560.7 7567.5 7582.4 7594.8 7503.5 7524.0 7540.1 7547.7 7577.1 7551.0 7594.0 7634.5 7640.0 7649.3 37122.6 37403.8 37698.8 37756.6 37809.0 2933.0 2947.2 2986.0 3114.3 3288.4 27378.3 27885.3 28094.4 28405.3 29717.6 3415.8 3455.4 3480.5 3500.2 3512.8 246850.0 247706.0 248946.0 249911.0 250191.0 50361.5 50679.7 50707.0 50798.5 50866.2 31248.0 32033.7 32260.2 33751.7 34029.7 13787.7 13861.9 13915.8 13939.0 13958.6 10488.7 10553.9 10609.2 10619.8 10622.0 17242.9 17406.8 17439.4 17446.7 17470.6 6626.7 6821.4 6888.4 6979.7 7079.4 751.2 853.5 861.3 884.8 905.8 26238.0 27483.5 27976.2 27985.0 28093.4 818.5 925.5 936.2 948.5 985.6 14197.3 14412.3 14561.3 14624.6 14703.1 333561.0 334783.0 335077.0 336944.0 338290.0 45793.0 46306.8 46379.5 46715.3 46866.5 1150.6 1157.9 1182.7 1183.4 1186.8 24764.4 25495.5 26633.7 26759.3 26919.9 39966.6 40424.6 40445.4 40457.8 40549.0 305600.0 306537.0 306906.0 307448.0 311228.0 24233.3 24621.4 24909.3 24911.0 24929.0 39943.6 40549.4 41009.8 41106.0 41343.4 35082.5 35158.3 35398.6 35434.1 35970.6 34985.5 35024.3 35137.8 35225.6 35264.6 26892.2 34649.7 34736.0 35006.0 35524.1 25261.0 30070.5 31670.0 31785.5 31924.5 24394.1 24728.3 24934.0 24936.1 25059.5 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | [#2] jquery.html Cycles:180 Average:22480.85 Median:49470.51 stddev:55687.06 (112.6%) stddev-sans-first:55818.49 12:42:30 INFO - PROCESS | 22974 | Values: 353.5 363.3 369.8 372.4 385.4 15301.5 16427.3 16848.3 16856.7 16887.7 15141.8 16438.9 16601.9 16832.0 16850.6 4926.3 5192.8 5193.7 5202.1 5203.6 3642.8 3834.1 5097.9 5663.8 5935.7 6002.8 6011.2 6011.6 6012.0 6017.8 5782.4 5965.5 5976.2 6001.0 6004.5 5111.2 5257.3 5263.1 5266.3 5275.3 19752.2 20031.1 20070.3 20078.0 20106.9 1937.8 1951.2 1984.6 2011.7 2506.6 12773.0 12890.8 13061.4 13378.0 13729.2 1677.1 1689.2 1703.4 1705.6 1756.6 65629.7 67561.7 67943.3 68464.0 70474.6 9275.0 9309.3 9633.9 9829.1 9896.1 13000.9 13096.9 13143.9 13283.1 13353.8 6358.8 6579.6 6716.8 6882.6 6905.5 5808.8 5902.7 5983.8 6127.4 6127.9 5790.1 5846.1 5880.4 5913.6 6012.5 1612.6 1669.3 1695.5 1737.8 1823.6 821.5 836.8 846.5 872.6 913.7 15910.1 15935.8 16309.8 16521.9 16803.8 842.7 852.0 880.3 885.8 906.5 9221.9 9640.0 9666.5 9695.8 9840.2 323175.0 325896.0 342562.0 344079.0 346153.0 64991.0 68000.0 68288.3 69720.7 69729.7 887.9 893.5 913.6 918.5 925.0 14696.0 14839.0 14856.0 15203.5 15316.7 33228.5 33831.3 35324.8 35832.0 40398.8 49308.5 49632.5 50173.0 50547.0 50653.2 5102.7 7358.0 7494.2 7567.3 7649.3 9652.4 11731.7 11858.6 12074.9 12156.9 10091.0 10098.7 10099.5 10415.2 10642.1 9840.2 10178.4 10258.6 10389.0 10498.4 10367.3 10385.7 10565.2 10820.6 10858.9 6428.5 6570.6 6726.3 7375.7 7575.9 9653.6 10548.5 10552.5 10739.8 11100.3 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | [#3] mootools.html Cycles:180 Average:4904.71 Median:4855.32 stddev:2737.76 (56.4%) stddev-sans-first:2732.31 12:42:30 INFO - PROCESS | 22974 | Values: 1337.6 1362.5 1435.9 1609.5 1639.4 6470.6 6683.8 7133.6 7753.5 7753.7 7336.6 7662.3 7664.8 7667.6 7669.0 2088.4 2099.8 2114.3 2116.0 2117.8 2107.6 2128.3 2132.1 2149.7 2161.9 2122.8 2138.0 2139.3 2147.8 2151.6 2097.2 2098.0 2101.6 2117.0 2123.0 2030.3 2065.2 2070.8 2072.9 2075.9 7605.5 7655.8 7660.3 7665.2 7672.9 4250.2 4377.2 4384.5 4398.2 4454.1 2819.7 2871.7 2911.3 2938.0 2940.0 878.8 908.1 911.2 926.8 927.3 10123.8 10166.7 10215.1 10217.1 10236.3 3726.3 3975.4 4017.2 4043.6 4066.3 8661.3 8688.0 8694.9 8704.2 8706.1 4466.0 4484.3 4484.8 4489.8 4492.3 3489.5 3622.7 3789.6 4101.2 4106.2 3418.9 3535.1 3601.6 3635.1 3749.8 1098.4 1120.5 1123.3 1125.9 1127.0 662.9 715.7 791.1 818.0 839.8 4836.2 4874.4 4945.9 5029.7 5158.6 370.8 382.8 383.2 383.6 389.0 3424.4 3454.6 3779.9 3897.7 3934.5 9015.7 9135.6 9169.7 9196.8 9245.4 9080.9 9083.5 9114.7 9187.1 9220.9 6573.8 6875.5 6940.6 7099.4 7151.4 5145.7 5146.5 5184.2 5280.9 5537.7 7951.2 8337.9 8396.5 8422.5 8428.0 8325.3 8362.5 8387.8 8512.5 8533.5 5811.6 5994.8 6310.5 6405.3 6409.9 6880.4 7104.1 7154.1 7318.9 7323.6 6395.4 6460.9 6540.9 6582.4 6746.4 6172.1 6252.0 6276.7 6283.8 6288.8 5914.9 6044.4 6044.9 6051.7 6074.9 4451.8 4453.3 4485.1 4533.7 4539.9 4364.8 4404.1 4409.7 4417.2 4419.6 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | [#4] prototype.html Cycles:180 Average:4307.67 Median:4983.48 stddev:1292.02 (25.9%) stddev-sans-first:1259.77 12:42:30 INFO - PROCESS | 22974 | Values: 279.3 281.8 288.2 289.2 290.4 5022.0 5050.6 5085.4 5091.7 5098.0 4955.7 4961.8 4967.4 4967.7 4968.9 3632.4 3694.2 3740.8 3817.1 3832.0 3811.7 3818.1 3822.7 3823.5 3856.1 3819.2 3828.1 3829.0 3832.3 3837.9 3522.9 3725.3 3829.8 3848.3 3877.7 3217.4 3217.7 3219.4 3228.4 3238.5 4809.1 4832.7 4844.4 4845.6 4873.3 4261.9 4272.4 4277.7 4278.9 4312.7 4998.1 5095.3 5097.7 5145.4 5160.5 3491.4 3504.9 3523.5 3529.3 3553.8 5405.3 5428.3 5486.7 5496.8 5523.7 3593.1 3619.1 3657.6 3670.9 3705.3 3698.8 3699.8 3706.7 3730.7 3734.6 4320.7 4321.7 4327.6 4337.8 4341.2 4864.9 5220.4 5241.4 5247.7 5256.4 1260.7 1294.1 1295.4 1295.6 1295.6 780.6 797.8 804.6 805.3 808.8 4542.6 4677.0 4694.5 4705.5 4715.3 5441.6 5466.3 5472.4 5474.8 5497.4 4579.5 4633.6 4671.3 4677.9 4689.1 2837.5 2858.2 2870.8 2887.6 2899.7 5077.9 5115.4 5123.9 5146.0 5167.6 5200.9 5429.8 5443.0 5467.6 5488.6 5062.8 5067.8 5117.3 5129.7 5135.8 5383.2 5400.0 5401.8 5403.2 5404.5 5017.5 5278.4 5287.7 5324.2 5375.2 5160.6 5165.2 5177.6 5186.3 5186.9 3733.7 3743.0 3767.0 3769.4 3791.0 5153.6 5355.5 5440.5 5496.9 5520.6 5221.3 5231.2 5240.6 5241.9 5261.2 5236.4 5261.7 5267.5 5270.2 5281.3 5067.9 5099.4 5121.0 5130.3 5145.0 5003.7 5143.4 5158.1 5225.5 5277.3 5150.6 5154.6 5156.6 5167.5 5173.7 12:42:30 INFO - PROCESS | 22974 | 12:42:30 INFO - PROCESS | 22974 | [#5] yui.html Cycles:180 Average:16591.73 Median:39987.50 stddev:23148.84 (57.9%) stddev-sans-first:23182.56 12:42:30 INFO - PROCESS | 22974 | Values: 580.1 588.4 610.4 708.6 715.7 11952.4 12941.6 12985.8 12997.1 13039.1 11870.1 12000.9 12073.2 12091.3 12174.8 707.9 728.6 729.1 730.7 731.2 718.9 749.3 753.1 756.5 757.1 775.0 779.2 780.4 781.6 783.0 771.3 772.2 772.3 774.0 778.0 568.5 570.4 571.5 571.6 573.0 12828.2 12902.6 12912.9 12913.1 12928.5 13920.4 14138.2 14332.4 14499.0 14526.2 11194.7 11233.4 11258.1 11326.4 11870.2 3212.5 3287.9 3344.9 3350.9 3353.4 65145.7 65658.3 65724.3 66292.7 67055.0 10531.6 10599.3 10669.3 10710.4 10793.0 19174.6 19484.5 19489.4 19619.4 19621.0 6881.7 6918.7 6921.7 7145.3 7270.6 3807.7 3908.0 3916.3 3953.9 3961.3 2835.0 2921.2 2939.6 2949.1 2950.1 482.7 490.5 490.9 493.9 498.9 459.5 490.0 516.8 524.0 536.5 7739.1 7872.4 8111.3 8237.7 8252.5 514.9 521.4 523.1 529.9 543.5 3620.9 3623.4 3752.0 3813.8 4047.1 56944.0 57161.7 59077.4 104302.5 104630.0 84180.2 85513.0 86163.0 86549.6 89437.6 48314.8 57293.7 76365.6 76898.2 79308.0 6784.4 6902.3 6993.1 7012.9 7310.4 36981.0 37630.4 38221.6 47422.0 48021.5 37819.4 39936.6 40038.4 42555.8 58779.1 11113.3 11572.8 11589.7 11606.4 11629.2 12098.4 12610.5 12787.6 12857.5 12965.9 12365.4 12620.7 12640.7 12686.8 12871.7 11038.0 11200.7 11394.7 11725.6 12568.2 11546.9 11569.9 11988.5 12071.9 12436.2 9549.8 9940.4 9973.4 10089.4 10211.5 8778.6 9465.0 10327.1 10416.3 10471.6 12:42:30 INFO - PROCESS | 22974 | -------- Summary: end -------- 12:42:30 INFO - PROCESS | 22974 | 12:42:31 INFO - TEST-INFO | 22974: exit 0 12:42:31 INFO - TEST-OK | dromaeo_css | took 1118423ms 12:42:31 INFO - TEST-START | kraken 12:42:31 INFO - operating with platform_type : linux_ 12:42:31 INFO - Initialising browser for kraken test... 12:42:31 INFO - TEST-INFO | started process 23324 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkiE5aV/profile http://localhost:35833/getInfo.html) 12:42:36 INFO - PROCESS | 23324 | __metrics Screen width/height:1600/1200 12:42:36 INFO - PROCESS | 23324 | colorDepth:24 12:42:36 INFO - PROCESS | 23324 | Browser inner width/height: 1024/697 12:42:36 INFO - PROCESS | 23324 | __metrics 12:42:36 ERROR - PROCESS | 23324 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3067: TypeError: this.tabs is undefined 12:42:37 INFO - TEST-INFO | 23324: exit 0 12:42:37 INFO - Browser initialized. 12:42:37 INFO - Running cycle 1/1 for kraken test... 12:42:37 INFO - TEST-INFO | started process 23446 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkiE5aV/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:42:49 INFO - PROCESS | 23446 | RSS: Main: 186150912 12:42:49 INFO - PROCESS | 23446 | 12:42:52 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35833/tests/kraken/driver.html?testName=audio-beat-detection) 12:42:53 INFO - PROCESS | 23446 | RSS: Main: 199651328 12:42:53 INFO - PROCESS | 23446 | 12:42:56 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35833/tests/kraken/driver.html?testName=audio-dft) 12:42:57 INFO - PROCESS | 23446 | RSS: Main: 198684672 12:42:57 INFO - PROCESS | 23446 | 12:43:00 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35833/tests/kraken/driver.html?testName=audio-fft) 12:43:01 INFO - PROCESS | 23446 | RSS: Main: 193781760 12:43:01 INFO - PROCESS | 23446 | 12:43:03 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35833/tests/kraken/driver.html?testName=audio-oscillator) 12:43:03 INFO - PROCESS | 23446 | RSS: Main: 194449408 12:43:03 INFO - PROCESS | 23446 | 12:43:05 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35833/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:43:06 INFO - PROCESS | 23446 | RSS: Main: 195002368 12:43:06 INFO - PROCESS | 23446 | 12:43:09 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35833/tests/kraken/driver.html?testName=imaging-darkroom) 12:43:10 INFO - PROCESS | 23446 | RSS: Main: 194732032 12:43:10 INFO - PROCESS | 23446 | 12:43:13 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35833/tests/kraken/driver.html?testName=imaging-desaturate) 12:43:14 INFO - PROCESS | 23446 | RSS: Main: 192462848 12:43:14 INFO - PROCESS | 23446 | 12:43:17 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35833/tests/kraken/driver.html?testName=json-parse-financial) 12:43:18 INFO - PROCESS | 23446 | RSS: Main: 194273280 12:43:18 INFO - PROCESS | 23446 | 12:43:19 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35833/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:43:20 INFO - PROCESS | 23446 | RSS: Main: 194531328 12:43:20 INFO - PROCESS | 23446 | 12:43:22 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:43:23 INFO - PROCESS | 23446 | RSS: Main: 194560000 12:43:23 INFO - PROCESS | 23446 | 12:43:25 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:43:26 INFO - PROCESS | 23446 | RSS: Main: 194260992 12:43:26 INFO - PROCESS | 23446 | 12:43:28 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:43:29 INFO - PROCESS | 23446 | RSS: Main: 194498560 12:43:29 INFO - PROCESS | 23446 | 12:43:32 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:43:33 INFO - PROCESS | 23446 | RSS: Main: 194457600 12:43:33 INFO - PROCESS | 23446 | 12:43:34 INFO - PROCESS | 23446 | Cycle 1(1): loaded http://localhost:35833/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35833/tests/kraken/driver.html?testName=ai-astar) 12:43:35 INFO - PROCESS | 23446 | RSS: Main: 197066752 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | __start_tp_report 12:43:35 INFO - PROCESS | 23446 | _x_x_mozilla_page_load 12:43:35 INFO - PROCESS | 23446 | _x_x_mozilla_page_load_details 12:43:35 INFO - PROCESS | 23446 | |i|pagename|runs| 12:43:35 INFO - PROCESS | 23446 | |0;ai-astar;111;119;120;119;119;119;118;118;120;119 12:43:35 INFO - PROCESS | 23446 | |1;audio-beat-detection;155;128;127;171;127;126;131;126;167;124 12:43:35 INFO - PROCESS | 23446 | |2;audio-dft;171;167;165;164;165;165;164;168;164;167 12:43:35 INFO - PROCESS | 23446 | |3;audio-fft;78;76;76;115;77;78;77;77;95;79 12:43:35 INFO - PROCESS | 23446 | |4;audio-oscillator;85;85;108;84;88;83;114;84;84;112 12:43:35 INFO - PROCESS | 23446 | |5;imaging-gaussian-blur;119;118;117;117;118;119;119;117;118;120 12:43:35 INFO - PROCESS | 23446 | |6;imaging-darkroom;148;147;149;149;148;149;148;149;149;149 12:43:35 INFO - PROCESS | 23446 | |7;imaging-desaturate;97;97;96;96;96;95;96;96;95;96 12:43:35 INFO - PROCESS | 23446 | |8;json-parse-financial;63;66;64;65;66;64;64;64;64;64 12:43:35 INFO - PROCESS | 23446 | |9;json-stringify-tinderbox;65;66;66;66;68;65;66;71;66;67 12:43:35 INFO - PROCESS | 23446 | |10;stanford-crypto-aes;85;85;83;87;82;86;84;84;83;85 12:43:35 INFO - PROCESS | 23446 | |11;stanford-crypto-ccm;147;139;139;134;135;133;153;145;170;144 12:43:35 INFO - PROCESS | 23446 | |12;stanford-crypto-pbkdf2;172;175;173;177;173;171;172;172;174;171 12:43:35 INFO - PROCESS | 23446 | |13;stanford-crypto-sha256-iterative;73;71;71;72;69;70;69;72;70;69 12:43:35 INFO - PROCESS | 23446 | __end_tp_report 12:43:35 INFO - PROCESS | 23446 | __start_cc_report 12:43:35 INFO - PROCESS | 23446 | _x_x_mozilla_cycle_collect,884 12:43:35 INFO - PROCESS | 23446 | __end_cc_report 12:43:35 INFO - PROCESS | 23446 | __startTimestamp1474573415111__endTimestamp 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | ------- Summary: start ------- 12:43:35 INFO - PROCESS | 23446 | Number of tests: 14 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#0] ai-astar Cycles:10 Average:118.20 Median:119.00 stddev:2.62 (2.2%) stddev-sans-first:0.71 12:43:35 INFO - PROCESS | 23446 | Values: 111.0 119.0 120.0 119.0 119.0 119.0 118.0 118.0 120.0 119.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#1] audio-beat-detection Cycles:10 Average:138.20 Median:129.50 stddev:18.54 (14.3%) stddev-sans-first:18.64 12:43:35 INFO - PROCESS | 23446 | Values: 155.0 128.0 127.0 171.0 127.0 126.0 131.0 126.0 167.0 124.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#2] audio-dft Cycles:10 Average:166.00 Median:166.00 stddev:2.26 (1.4%) stddev-sans-first:1.51 12:43:35 INFO - PROCESS | 23446 | Values: 171.0 167.0 165.0 164.0 165.0 165.0 164.0 168.0 164.0 167.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#3] audio-fft Cycles:10 Average:82.80 Median:77.50 stddev:12.65 (16.3%) stddev-sans-first:13.29 12:43:35 INFO - PROCESS | 23446 | Values: 78.0 76.0 76.0 115.0 77.0 78.0 77.0 77.0 95.0 79.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#4] audio-oscillator Cycles:10 Average:92.70 Median:84.00 stddev:13.00 (15.5%) stddev-sans-first:13.49 12:43:35 INFO - PROCESS | 23446 | Values: 85.0 85.0 108.0 84.0 88.0 83.0 114.0 84.0 84.0 112.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.50 stddev:1.03 (0.9%) stddev-sans-first:1.05 12:43:35 INFO - PROCESS | 23446 | Values: 119.0 118.0 117.0 117.0 118.0 119.0 119.0 117.0 118.0 120.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#6] imaging-darkroom Cycles:10 Average:148.50 Median:149.00 stddev:0.71 (0.5%) stddev-sans-first:0.73 12:43:35 INFO - PROCESS | 23446 | Values: 148.0 147.0 149.0 149.0 148.0 149.0 148.0 149.0 149.0 149.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:0.67 (0.7%) stddev-sans-first:0.60 12:43:35 INFO - PROCESS | 23446 | Values: 97.0 97.0 96.0 96.0 96.0 95.0 96.0 96.0 95.0 96.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#8] json-parse-financial Cycles:10 Average:64.40 Median:64.00 stddev:0.97 (1.5%) stddev-sans-first:0.88 12:43:35 INFO - PROCESS | 23446 | Values: 63.0 66.0 64.0 65.0 66.0 64.0 64.0 64.0 64.0 64.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#9] json-stringify-tinderbox Cycles:10 Average:66.60 Median:66.00 stddev:1.78 (2.7%) stddev-sans-first:1.79 12:43:35 INFO - PROCESS | 23446 | Values: 65.0 66.0 66.0 66.0 68.0 65.0 66.0 71.0 66.0 67.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#10] stanford-crypto-aes Cycles:10 Average:84.40 Median:85.00 stddev:1.51 (1.8%) stddev-sans-first:1.58 12:43:35 INFO - PROCESS | 23446 | Values: 85.0 85.0 83.0 87.0 82.0 86.0 84.0 84.0 83.0 85.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#11] stanford-crypto-ccm Cycles:10 Average:143.90 Median:144.50 stddev:11.15 (7.7%) stddev-sans-first:11.77 12:43:35 INFO - PROCESS | 23446 | Values: 147.0 139.0 139.0 134.0 135.0 133.0 153.0 145.0 170.0 144.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:173.00 Median:173.00 stddev:1.89 (1.1%) stddev-sans-first:1.96 12:43:35 INFO - PROCESS | 23446 | Values: 172.0 175.0 173.0 177.0 173.0 171.0 172.0 172.0 174.0 171.0 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.60 Median:71.00 stddev:1.43 (2.0%) stddev-sans-first:1.22 12:43:35 INFO - PROCESS | 23446 | Values: 73.0 71.0 71.0 72.0 69.0 70.0 69.0 72.0 70.0 69.0 12:43:35 INFO - PROCESS | 23446 | -------- Summary: end -------- 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | ###!!! [Parent][MessageChannel] Error: (msgtype=0x2000B,name=PAPZ::Msg_Destroy) Channel error: cannot send/recv 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | 12:43:35 INFO - PROCESS | 23446 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 12:43:35 INFO - PROCESS | 23446 | 12:43:36 INFO - TEST-INFO | 23446: exit 0 12:43:36 INFO - TEST-OK | kraken | took 65216ms 12:43:36 INFO - SUITE-END | took 1183s 12:43:36 INFO - Completed test suite (00:19:44) 12:43:36 INFO - javascript benchmark 12:43:36 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6266.992139529339, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2628.9999999999995, 2643.4316621926296, 2652.7877769778415, 2668.6664166979126, 2672.3319170207446, 4567.0, 4676.1349150407195, 4741.2651039089, 4747.572718455338, 4827.25177597473, 4640.976795116028, 4663.883402914928, 4688.273317635763, 4694.342792009122, 4702.529747025295, 4317.827286908519, 4356.586124318184, 4404.163208990281, 4425.203463376591, 4474.798634061459, 4184.602462766033, 4264.4882614086355, 4339.305711086226, 4370.759608221562, 4381.430414046185, 4242.7030107892615, 4320.546342634041, 4351.042770590465, 4356.542563030868, 4425.734455932655, 4353.695241333108, 4363.600366273189, 4384.539623339535, 4394.648428125743, 4440.311751678495, 4086.162336720965, 4352.7823608819435, 4353.869383918487, 4360.803763830635, 4391.538888416702, 4560.338750881137, 4576.588107070346, 4642.930356044662, 4663.48701642819, 4722.220833562458, 4942.061008408391, 4954.900901981976, 4965.131102057126, 4971.867211247144, 5028.044671512401, 5005.124103281947, 5007.273945277951, 5009.524095210949, 5011.173156429185, 5078.542931136216, 4580.679352445331, 4625.861224163281, 4648.48866624671, 4675.4155730533685, 4685.835995740133, 5138.460461651547, 5140.280360749498, 5157.484251574812, 5170.741462926839, 5209.218617207373, 4929.975350123226, 4944.184209605375, 4946.060248552763, 4948.777305021283, 5005.899882002413, 4885.438174609894, 4926.359573255454, 4960.751962401865, 4983.127952608279, 5014.648974571818, 4970.502949705001, 4973.079980203674, 4988.35151430319, 5031.823886163967, 5046.293518907356, 4854.417469903634, 4904.779284932187, 4936.48166942473, 4948.208286674115, 5001.8499445016705, 4185.686073544496, 4233.576642335742, 4276.764777937181, 4308.9353659695125, 4330.978345108254, 3742.176721121349, 3750.624937506282, 3758.7368884177845, 3798.2783271178387, 3807.428885667172, 4374.03771170342, 4416.24923762961, 4433.490148632884, 4437.511873693891, 4439.822407103679, 4884.242942343943, 4884.7313397762755, 4996.625253105959, 5046.1673823818655, 5061.595072394273, 4383.298672212431, 4401.537838526972, 4423.867283981485, 4432.889177770581, 4445.26653102241, 4587.42657167854, 4599.471060827981, 4601.470830854428, 4604.401427814362, 4659.976700116477, 4619.0, 4705.600023997861, 4743.620510359094, 4804.975975120102, 4810.63920205993, 5058.848234552969, 5103.413107492686, 5115.360579927509, 5131.332926719502, 5154.845354639367, 4800.159972004955, 4801.375821143229, 4810.6632535722165, 4814.494478079751, 4867.026594681007, 4835.734034628129, 4880.95119048805, 5009.9248511271635, 5021.84934451967, 5071.594272458268, 4935.580475659609, 4991.126552853164, 5000.849974500771, 5011.123053465702, 5046.47012063728, 4873.829415970424, 4884.853454396374, 4887.43794463627, 4896.730679812502, 4955.157623204136, 4774.498677638798, 4881.145799485005, 4923.975380123076, 4930.6795058321095, 4938.48145944685, 4761.714297142183, 4808.3989501312335, 4843.75781210931, 4901.41183058021, 4996.175631020841, 5004.42449118356, 5012.523810238022, 5019.422766381913, 5021.84934451967, 5040.294358789845, 4702.553257440538, 4770.522947705202, 4918.311436398835, 4920.015996800726, 4923.65534412602], "value": 4627.107305738387, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [526.7550588976126, 529.9496547827956, 543.3344153412071, 548.23247453565, 551.495381725721, 38730.41904371433, 40388.39417408738, 40631.98420039497, 43520.347194792026, 43530.0, 38824.611753882455, 39238.411423828664, 39346.40980385296, 39441.605583944154, 39720.40419393704, 7687.846243075149, 7837.921620783776, 7847.097583777853, 7856.332211762007, 7859.803504912395, 7430.962845185766, 7475.2524747525085, 7482.775516734507, 7543.283388078124, 7551.622418879034, 7506.324430801227, 7560.659770310322, 7567.470277080606, 7582.393408527305, 7594.772156835304, 7503.512271702322, 7523.962380188092, 7540.095188577351, 7547.735829246005, 7577.128630207541, 7550.9622451887935, 7593.962030189814, 7634.50375725576, 7640.044994375703, 7649.349805266559, 37122.62877371219, 37403.81298093492, 37698.81150594257, 37756.622433775585, 37809.0, 2932.9853350733324, 2947.2042548511995, 2986.0146151769864, 3114.299282661406, 3288.391647545212, 27378.315542111406, 27885.302867428272, 28094.43811123766, 28405.289867753265, 29717.55423668647, 3415.829208539588, 3455.4125798614295, 3480.547528821237, 3500.2124521982605, 3512.8067956262394, 246850.0, 247706.0, 248946.0, 249911.0, 250191.0, 50361.496385036415, 50679.74660126676, 50707.0, 50798.49201508011, 50866.23700644419, 31248.0, 32033.679663203537, 32260.19349516281, 33751.662483375345, 34029.65970340265, 13787.655308617364, 13861.86138138626, 13915.791263131061, 13939.0, 13958.58124256274, 10488.68533943983, 10553.894461055444, 10609.204309676805, 10619.84070238947, 10622.044016038593, 17242.913785431243, 17406.825931740776, 17439.389621363192, 17446.738298925527, 17470.56323591895, 6626.734930602818, 6821.420179284717, 6888.41448476885, 6979.651017449107, 7079.39825114871, 751.2262369759156, 853.50923219148, 861.3109512390063, 884.7788052986754, 905.8188362327561, 26238.0, 27483.450330993666, 27976.160715178576, 27985.0, 28093.43813123726, 818.4557269415891, 925.4586067150658, 936.2463217110155, 948.4972964328916, 985.5515740338129, 14197.345804852594, 14412.279386030657, 14561.344739486749, 14624.561263162122, 14703.117812931258, 333561.0, 334783.0, 335077.0, 336944.0, 338290.0, 45793.0, 46306.76846615745, 46379.53620463752, 46715.29927051097, 46866.5313346869, 1150.5685367987005, 1157.8784227656142, 1182.698411904976, 1183.4319526627096, 1186.768580126867, 24764.38089047788, 25495.490090198462, 26633.733662663126, 26759.331016724736, 26919.865400672872, 39966.600333996284, 40424.595754042086, 40445.39331909965, 40457.797711011255, 40549.0, 305600.0, 306537.0, 306906.0, 307448.0, 311228.0, 24233.273001809976, 24621.38446538851, 24909.252722418358, 24911.0, 24929.0, 39943.60056399515, 40549.39175912305, 41009.794951025055, 41106.0, 41343.37984930168, 35082.47376289307, 35158.29683406266, 35398.646013540565, 35434.11414714653, 35970.640293597775, 34985.475217871244, 35024.29951401009, 35137.824310878284, 35225.64774352223, 35264.64735352614, 26892.193234203005, 34649.653503464644, 34736.0, 35006.0, 35524.11189720174, 25261.0, 30070.548941765453, 31670.0, 31785.523217151298, 31924.45548662565, 24394.146204882745, 24728.25815225546, 24934.0, 24936.127235546668, 25059.49881002333], "value": 16710.730179813363, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [353.45920741265854, 363.3115246607678, 369.8187887934911, 372.42274474564454, 385.3622255167697, 15301.464448744282, 16427.34290628375, 16848.32606695732, 16856.747148792747, 16887.746683799753, 15141.848581514181, 16438.917805410987, 16601.916990415062, 16832.0, 16850.578735531617, 4926.261060840867, 5192.844214673566, 5193.714345710984, 5202.115640341132, 5203.583713302945, 3642.7996460194677, 3834.118152824838, 5097.949020509803, 5663.773449062032, 5935.703214839263, 6002.8499287517725, 6011.158437818709, 6011.639301641915, 6012.038073908176, 6017.7592896284095, 5782.3639399666, 5965.522758179357, 5976.193213916109, 6000.969995150018, 6004.519638428916, 5111.2333150027425, 5257.316548848664, 5263.131583288753, 5266.262723218752, 5275.261463395128, 19752.209911603517, 20031.09860056301, 20070.297539586045, 20078.0, 20106.899465502724, 1937.7577802774654, 1951.2097600471832, 1984.5931584025384, 2011.688188330811, 2506.6490691303234, 12773.0, 12890.80663790044, 13061.412236449383, 13378.0, 13729.176249425067, 1677.1278934953878, 1689.1976311252179, 1703.4123227486498, 1705.6077102266547, 1756.6398888228011, 65629.67185164092, 67561.66219168872, 67943.3205667942, 68464.0, 70474.64762676154, 9274.95362523183, 9309.30180236485, 9633.90366096344, 9829.066238707312, 9896.140505202977, 13000.934995324962, 13096.934515327554, 13143.934280328729, 13283.136596121221, 13353.799693004612, 6358.809235722936, 6579.605223686498, 6716.83207919806, 6882.5870447773295, 6905.482088843357, 5808.767649293981, 5902.675352855548, 5983.790567330123, 6127.356627554132, 6127.908081378783, 5790.10253410722, 5846.1230815377185, 5880.441358070976, 5913.615614985099, 6012.458878700938, 1612.6371566397702, 1669.348953907977, 1695.4913525942168, 1737.7654016707584, 1823.5988082621802, 821.5317269156643, 836.8284501677142, 846.5132548784474, 872.5637181409295, 913.7304495173939, 15910.12494312824, 15935.840641593668, 16309.83690163107, 16521.9260748051, 16803.831961680473, 842.6839935024366, 851.9829603408022, 880.3221519430003, 885.818407226517, 906.5421961909194, 9221.90778092224, 9640.035996400444, 9666.516674166263, 9695.806083878424, 9840.212782977345, 323175.0, 325896.0, 342562.0, 344079.0, 346153.0, 64991.0, 68000.0, 68288.31711682919, 69720.6513967437, 69729.65135174291, 887.942283751567, 893.5219657483216, 913.5980168725739, 918.5177781664679, 925.0194793518891, 14696.0, 14839.0, 14856.0, 15203.467878624195, 15316.693666126392, 33228.50157247692, 33831.32337353288, 35324.82337588296, 35832.0, 40398.79800600978, 49308.50691493039, 49632.50367496279, 50173.0, 50547.0, 50653.24020139775, 5102.69383836971, 7357.963210183915, 7494.213107623621, 7567.281108294703, 7649.31156195945, 9652.420854748738, 11731.706707332385, 11858.644240672793, 12074.879251207376, 12156.93921530422, 10091.0, 10098.697039088838, 10099.495025248561, 10415.218858585486, 10642.148628109888, 9840.163586094975, 10178.440185789557, 10258.58965641366, 10389.0, 10498.370097794157, 10367.32612380193, 10385.688429347132, 10565.20760942917, 10820.56717731282, 10858.891411086104, 6428.517861160525, 6570.638614876228, 6726.260111387645, 7375.741849035258, 7575.924240757522, 9653.565589548627, 10548.472576370998, 10552.525136369035, 10739.838902416626, 11100.333979961228], "value": 8155.103798590195, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1337.6054064051107, 1362.4550179928028, 1435.885129189665, 1609.476920001, 1639.4262008297098, 6470.579412338195, 6683.766068187614, 7133.643317834107, 7753.457257991943, 7753.651085701143, 7336.633168341588, 7662.272084151997, 7664.770056898302, 7667.5782831944225, 7669.0, 2088.3943656339643, 2099.8110170084688, 2114.3339847947923, 2115.957680846382, 2117.830573554112, 2107.589020141073, 2128.3082998025625, 2132.136484723682, 2149.6668016457475, 2161.859479133859, 2122.840786940978, 2137.9893100534478, 2139.2833400810746, 2147.8281737460966, 2151.634222182225, 2097.2345094040716, 2097.97199372308, 2101.6112019276484, 2117.047328702075, 2123.0, 2030.3299911029326, 2065.163608738463, 2070.782567830371, 2072.9481762955897, 2075.9169633214806, 7605.5436673799195, 7655.846883062308, 7660.348870346027, 7665.156832748393, 7672.884906726348, 4250.171216612762, 4377.212101821671, 4384.517703052662, 4398.208322501949, 4454.13144436835, 2819.7180281971846, 2871.684114747376, 2911.30128769096, 2938.030449951511, 2939.9706002940125, 878.7875842090468, 908.1418059933366, 911.1890417528405, 926.7729406295433, 927.3493182135742, 10123.79752404955, 10166.694999150037, 10215.080642742114, 10217.080462758313, 10236.334638248565, 3726.347889119393, 3975.383815508601, 4017.196560687874, 4043.6360727534075, 4066.3290557057753, 8661.263792577702, 8688.0, 8694.91305086941, 8704.173103555278, 8706.085860984505, 4465.955340446554, 4484.327350897392, 4484.798184081724, 4489.775511224426, 4492.303692927601, 3489.45913383426, 3622.7464077514846, 3789.5831458539537, 4101.241270364992, 4106.178764247163, 3418.8973781124428, 3535.116220944764, 3601.603823579404, 3635.1457407509215, 3749.775013499199, 1098.3849044535086, 1120.5405783628673, 1123.337231033694, 1125.926814757038, 1127.0420142878488, 662.8806814773387, 715.7494876793185, 791.1455627921831, 817.9918200817916, 839.7774589733725, 4836.226203807374, 4874.4150701916, 4945.851624451272, 5029.673071250357, 5158.561522270574, 370.75344895644093, 382.829640809837, 383.2297082863409, 383.56656977615114, 389.0371330955918, 3424.434968230264, 3454.5854497460464, 3779.8643766271966, 3897.707671924617, 3934.5475270344277, 9015.729528114036, 9135.634574617074, 9169.724908252763, 9196.816063678689, 9245.352825302165, 9080.8637870432, 9083.545822708971, 9114.680986165453, 9187.127222913812, 9220.90779092214, 6573.769918052845, 6875.518713689994, 6940.583564986117, 7099.3965512930945, 7151.427885769126, 5145.71698556568, 5146.511081447256, 5184.170532714747, 5280.867978300574, 5537.6954267515675, 7951.165127661744, 8337.916620833957, 8396.454230475, 8422.536760477988, 8427.95786021066, 8325.292350150305, 8362.540060296498, 8387.790305242417, 8512.531810750468, 8533.487990720576, 5811.622244554091, 5994.790182343597, 6310.49516038725, 6405.295417504164, 6409.8718025640155, 6880.415164711056, 7104.076470058859, 7154.105736782903, 7318.926810731825, 7323.6338183089565, 6395.360463953567, 6460.935390646221, 6540.869182616226, 6582.407583317525, 6746.4265537429865, 6172.135900973777, 6251.9687401562705, 6276.717547710273, 6283.842903927255, 6288.779892703734, 5914.881702365842, 6044.365341639064, 6044.879102418015, 6051.697415129138, 6074.939250607614, 4451.755153466591, 4453.309736990772, 4485.147821913826, 4533.730555444481, 4539.863804085882, 4364.8472303469225, 4404.119176164716, 4409.735415875058, 4417.182821178092, 4419.558044195554], "value": 3893.2733753773223, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [279.30035261669514, 281.8125946245747, 288.1801275371567, 289.247955316178, 290.35251389401634, 5022.0, 5050.595952323814, 5085.389753229613, 5091.669041512299, 5098.0, 4955.653104282702, 4961.776720047597, 4967.379077615298, 4967.652264341497, 4968.850934471971, 3632.418812989922, 3694.150345420555, 3740.756850804689, 3817.0838998640406, 3832.0, 3811.6569508744205, 3818.1409182933758, 3822.694184465236, 3823.541175058997, 3856.11309398837, 3819.197968426634, 3828.119532507525, 3828.9808550957346, 3832.2527107214105, 3837.884863454101, 3522.903872196039, 3725.2549490102087, 3829.751066180689, 3848.326542855003, 3877.651011408987, 3217.4047801156626, 3217.7264932480534, 3219.3561287742546, 3228.386606544749, 3238.4656531672244, 4809.0763694522475, 4832.661713680044, 4844.442889067767, 4845.6123510119105, 4873.269009648581, 4261.914761704779, 4272.423222864935, 4277.657787377002, 4278.935815962763, 4312.698111132222, 4998.10034193845, 5095.261187127883, 5097.745112744385, 5145.3568303962, 5160.535551800319, 3491.3715531204375, 3504.8598056077726, 3523.453864650983, 3529.3117842020815, 3553.8223088845452, 5405.270313499682, 5428.321459817523, 5486.670799752028, 5496.835094947118, 5523.6685798852195, 3593.1017245688577, 3619.149499867529, 3657.579378371468, 3670.944935825965, 3705.2589482103685, 3698.815059247027, 3699.7595156314756, 3706.7405281630568, 3730.738848280594, 3734.6452087051684, 4320.719153255091, 4321.6974811762875, 4327.6105150536605, 4337.8481753138485, 4341.218580655449, 4864.881077352158, 5220.399654039758, 5241.42344342122, 5247.711375874287, 5256.369235691742, 1260.6659235302468, 1294.1199984010964, 1295.352323838081, 1295.591888555121, 1295.598364506987, 780.6292011294703, 797.8204903896577, 804.6459557794552, 805.255138996426, 808.8261023879894, 4542.568455996675, 4677.0, 4694.483606803249, 4705.482396936334, 4715.339852420664, 5441.6261917610545, 5466.289382380344, 5472.425395333512, 5474.810075969564, 5497.422770609109, 4579.546846295162, 4633.582977532038, 4671.27595222741, 4677.929831052537, 4689.132510485571, 2837.52448726661, 2858.185417156142, 2870.827750334945, 2887.566864970271, 2899.739023487854, 5077.949220507748, 5115.38615366151, 5123.89836185222, 5146.0, 5167.560757335594, 5200.855811721415, 5429.809956651498, 5442.9722005715485, 5467.5625949923915, 5488.643238189505, 5062.82280120194, 5067.7837319043165, 5117.283580298761, 5129.717275812302, 5135.845924622267, 5383.173833737163, 5400.0, 5401.810936617199, 5403.216533602685, 5404.513593776579, 5017.498250175099, 5278.445763194963, 5287.68273903567, 5324.227986941949, 5375.193720941734, 5160.612954028538, 5165.192182736012, 5177.611679124006, 5186.291801362045, 5186.870328241824, 3733.6639702425828, 3742.9812850935573, 3766.981165094157, 3769.4345848123003, 3791.0, 5153.587712983027, 5355.464453554613, 5440.483154100354, 5496.917546236729, 5520.558355331644, 5221.347331583552, 5231.189165679326, 5240.5807535397835, 5241.895162096813, 5261.237120617412, 5236.371635403776, 5261.6579922306455, 5267.473252674855, 5270.156774915995, 5281.287026251407, 5067.949320506747, 5099.439061703136, 5121.0, 5130.255313407459, 5145.0, 5003.749812509433, 5143.3570803649545, 5158.148905430562, 5225.529702326809, 5277.261183434399, 5150.6137039721425, 5154.587632989427, 5156.587473002076, 5167.457416971314, 5173.706573356661], "value": 3884.469836033702, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [580.0776764943738, 588.361627634017, 610.41095342994, 708.6385943168982, 715.7244460882561, 11952.402379881003, 12941.611751647453, 12985.805212921814, 12997.090203685746, 13039.087263891519, 11870.109741769358, 12000.939995300034, 12073.21524100935, 12091.334976576285, 12174.756504869898, 707.9256678048808, 728.6320408193855, 729.0704351951251, 730.7040648537325, 731.1993367262866, 718.8706032914073, 749.3480671815528, 753.0850017229066, 756.5233902641356, 757.1066141952493, 775.0273406874364, 779.185750890321, 780.4185881518276, 781.5584194929846, 783.0212234706617, 771.2827070824131, 772.2162005564356, 772.3242163107253, 773.9883901741479, 778.0274656679151, 568.5139205978911, 570.3640440908357, 571.4628249445508, 571.6312978129125, 572.9684867332295, 12828.166169198972, 12902.612921612366, 12912.870871291354, 12913.096083274175, 12928.48286068556, 13920.37358318878, 14138.222397768119, 14332.42670293187, 14499.0, 14526.201058941753, 11194.720131996684, 11233.382163980978, 11258.099352051899, 11326.377049262288, 11870.169088163831, 3212.534182543518, 3287.8849240276477, 3344.8996530104137, 3350.882719104844, 3353.446681297583, 65145.67427162881, 65658.3434165657, 65724.3427565723, 66292.6685366575, 67055.0, 10531.631392901212, 10599.258051936291, 10669.253152279265, 10710.410927398912, 10793.0, 19174.61650766977, 19484.51288717765, 19489.415317540213, 19619.411417657495, 19621.0, 6881.724731010703, 6918.688659010357, 6921.7356648234345, 7145.321194486515, 7270.563766174047, 3807.7144214184045, 3908.0, 3916.2950668879307, 3953.920921581552, 3961.3067713150085, 2834.9858250708617, 2921.2258751430886, 2939.6325459317586, 2949.0857834071508, 2950.0559820857547, 482.68143025602933, 490.5021403275678, 490.872373182975, 493.88146844757, 498.89772596617604, 459.4830815332751, 490.0419679526517, 516.8191133103384, 523.9554637855749, 536.5064140990298, 7739.148693643695, 7872.409569282212, 8111.269985701198, 8237.711680091288, 8252.504849709037, 514.9433562308143, 521.3665396543219, 523.1028785632658, 529.9284596579489, 543.4782608695697, 3620.9094772630897, 3623.4021386470936, 3751.9812400938367, 3813.8093095345675, 4047.1096358801015, 56944.0, 57161.71419142878, 59077.40922590719, 104302.47848760708, 104630.0, 84180.15819841724, 85513.0, 86163.0, 86549.56725216334, 89437.55281223552, 48314.75842620764, 57293.713531432906, 76365.5635496404, 76898.23101769022, 79308.0, 6784.423324017514, 6902.309769023058, 6993.125859267591, 7012.859742805013, 7310.415166786751, 36981.0, 37630.435543467414, 38221.61778382181, 47422.0, 48021.5197848031, 37819.432708508844, 39936.60063399329, 40038.39942400808, 42555.7872210637, 58779.061046948336, 11113.333200008025, 11572.768544628892, 11589.6523104307, 11606.361650108987, 11629.24409913353, 12098.395080246128, 12610.49558017669, 12787.61637150887, 12857.549985750828, 12965.870341296466, 12365.38173091324, 12620.747585048432, 12640.747185056063, 12686.809697854724, 12871.742565148832, 11038.0, 11200.663980080612, 11394.658160255205, 11725.589604363806, 12568.245905245714, 11546.884531154581, 11569.942150289195, 11988.460519276829, 12071.939640301742, 12436.19164754288, 9549.761255968657, 9940.403575785476, 9973.351732137387, 10089.394636321844, 10211.489425528842, 8778.604962776562, 9465.0, 10327.122194613241, 10416.32293900894, 10471.581136754749], "value": 6352.208418339837, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1563.5, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 119.0, 120.0, 119.0, 119.0, 119.0, 118.0, 118.0, 120.0, 119.0], "value": 118.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 128.0, 127.0, 171.0, 127.0, 126.0, 131.0, 126.0, 167.0, 124.0], "value": 138.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 167.0, 165.0, 164.0, 165.0, 165.0, 164.0, 168.0, 164.0, 167.0], "value": 166.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 76.0, 76.0, 115.0, 77.0, 78.0, 77.0, 77.0, 95.0, 79.0], "value": 82.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 108.0, 84.0, 88.0, 83.0, 114.0, 84.0, 84.0, 112.0], "value": 92.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 118.0, 117.0, 117.0, 118.0, 119.0, 119.0, 117.0, 118.0, 120.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 149.0, 149.0, 148.0, 149.0, 148.0, 149.0, 149.0, 149.0], "value": 148.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 97.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 95.0, 96.0], "value": 96.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 66.0, 64.0, 65.0, 66.0, 64.0, 64.0, 64.0, 64.0, 64.0], "value": 64.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 66.0, 66.0, 66.0, 68.0, 65.0, 66.0, 71.0, 66.0, 67.0], "value": 66.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 83.0, 87.0, 82.0, 86.0, 84.0, 84.0, 83.0, 85.0], "value": 84.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 139.0, 139.0, 134.0, 135.0, 133.0, 153.0, 145.0, 170.0, 144.0], "value": 143.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 175.0, 173.0, 177.0, 173.0, 171.0, 172.0, 172.0, 174.0, 171.0], "value": 173.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 71.0, 71.0, 72.0, 69.0, 70.0, 69.0, 72.0, 70.0, 69.0], "value": 70.6, "unit": "score"}]}]} 12:43:36 INFO - Return code: 0 12:43:36 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:43:36 ERROR - # TBPL SUCCESS # 12:43:36 INFO - Running post-action listener: _resource_record_post_action 12:43:36 INFO - [mozharness: 2016-09-22 19:43:36.912276Z] Finished run-tests step (success) 12:43:36 INFO - Running post-run listener: _resource_record_post_run 12:43:36 INFO - Total resource usage - Wall time: 1200s; CPU: 13.0%; Read bytes: 4096; Write bytes: 400998400; Read time: 8; Write time: 301496 12:43:36 INFO - TinderboxPrint: CPU usage
13.4% 12:43:36 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 12:43:36 INFO - TinderboxPrint: I/O write bytes / time
400,998,400 / 301,496 12:43:36 INFO - TinderboxPrint: CPU idle
8,288.3 (86.6%) 12:43:36 INFO - TinderboxPrint: CPU user
1,220.0 (12.7%) 12:43:36 INFO - TinderboxPrint: Swap in / out
0 / 0 12:43:36 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 110432256; Read time: 0; Write time: 64896 12:43:37 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 0; Write bytes: 290566144; Read time: 0; Write time: 236600 12:43:37 INFO - Running post-run listener: _upload_blobber_files 12:43:37 INFO - Blob upload gear active. 12:43:37 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:43:37 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 12:43:37 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'] 12:43:37 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 12:43:37 INFO - (blobuploader) - INFO - Open directory for files ... 12:43:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 12:43:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:43:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:43:42 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:43:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:43:42 INFO - (blobuploader) - INFO - Done attempting. 12:43:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 12:43:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:43:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:43:43 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 12:43:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:43:43 INFO - (blobuploader) - INFO - Done attempting. 12:43:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 12:43:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:43:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:43:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 12:43:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:43:44 INFO - (blobuploader) - INFO - Done attempting. 12:43:44 INFO - (blobuploader) - INFO - Iteration through files over. 12:43:44 INFO - Return code: 0 12:43:44 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:43:44 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:43:44 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9082603015c1310a6ad64d932bacb8ce56bc6814b631362da65a975a9ceaf5088164a846651734a38e068d3b49695999e410def19ccb404fb18c70dde644f31f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bde7bb93973258a61ebb11fa0a333c5d185d5e3a675326c339d18fd98db60c8d45097147cf325797cf69c247a46099daa238bb6c02844ad65cdbaf89072700a1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5f1b92a31e7d66b66122e50ab14ee5460442b434e413cdc36496c481fb01ec42549e21ccf8786e5a9e06eafdb122e65c0a52f9894cceda8101830df9261da982"} 12:43:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:43:44 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:43:44 INFO - Contents: 12:43:44 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9082603015c1310a6ad64d932bacb8ce56bc6814b631362da65a975a9ceaf5088164a846651734a38e068d3b49695999e410def19ccb404fb18c70dde644f31f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bde7bb93973258a61ebb11fa0a333c5d185d5e3a675326c339d18fd98db60c8d45097147cf325797cf69c247a46099daa238bb6c02844ad65cdbaf89072700a1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5f1b92a31e7d66b66122e50ab14ee5460442b434e413cdc36496c481fb01ec42549e21ccf8786e5a9e06eafdb122e65c0a52f9894cceda8101830df9261da982"} 12:43:44 INFO - Running post-run listener: copy_logs_to_upload_dir 12:43:44 INFO - Copying logs to upload dir... 12:43:44 INFO - mkdir: /builds/slave/test/build/upload/logs 12:43:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1244.149873 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 44 secs) (at 2016-09-22 12:43:43.670470) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-22 12:43:43.674163) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9082603015c1310a6ad64d932bacb8ce56bc6814b631362da65a975a9ceaf5088164a846651734a38e068d3b49695999e410def19ccb404fb18c70dde644f31f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bde7bb93973258a61ebb11fa0a333c5d185d5e3a675326c339d18fd98db60c8d45097147cf325797cf69c247a46099daa238bb6c02844ad65cdbaf89072700a1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5f1b92a31e7d66b66122e50ab14ee5460442b434e413cdc36496c481fb01ec42549e21ccf8786e5a9e06eafdb122e65c0a52f9894cceda8101830df9261da982"} build_url:https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011188 build_url: 'https://queue.taskcluster.net/v1/task/FWG6DySgQuyyOzrKZcrEmQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9082603015c1310a6ad64d932bacb8ce56bc6814b631362da65a975a9ceaf5088164a846651734a38e068d3b49695999e410def19ccb404fb18c70dde644f31f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bde7bb93973258a61ebb11fa0a333c5d185d5e3a675326c339d18fd98db60c8d45097147cf325797cf69c247a46099daa238bb6c02844ad65cdbaf89072700a1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5f1b92a31e7d66b66122e50ab14ee5460442b434e413cdc36496c481fb01ec42549e21ccf8786e5a9e06eafdb122e65c0a52f9894cceda8101830df9261da982"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-22 12:43:43.699813) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:43:43.700132) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1474569396.128395-1213159533 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004505 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 12:43:43.784888) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-22 12:43:43.785615) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-22 12:43:43.786307) ========= ========= Total master_lag: 0.18 =========