builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-016 starttime: 1474543089.45 results: success (0) buildid: 20160922025602 builduid: dd3494223b1a41a3b5452fee039acf5b revision: f0e6cc6360213ba21fd98c887b55fce5c680df68 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.449118) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.449590) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.449932) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.487071) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.487376) ========= 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=00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-22 04:18:09-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.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% 65.1M=0s 2016-09-22 04:18:09 (65.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.072627 ========= master_lag: 0.13 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.689172) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.689517) ========= 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=00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015461 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:09.743111) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-22 04:18:09.743478) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev f0e6cc6360213ba21fd98c887b55fce5c680df68 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev f0e6cc6360213ba21fd98c887b55fce5c680df68 --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=00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-22 04:18:10,009 truncating revision to first 12 chars 2016-09-22 04:18:10,009 Setting DEBUG logging. 2016-09-22 04:18:10,009 attempt 1/10 2016-09-22 04:18:10,009 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/f0e6cc636021?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-22 04:18:10,908 unpacking tar archive at: mozilla-central-f0e6cc636021/testing/mozharness/ program finished with exit code 0 elapsedTime=1.247504 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-22 04:18:11.016217) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:11.016546) ========= script_repo_revision: f0e6cc6360213ba21fd98c887b55fce5c680df68 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:11.017041) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:11.017360) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-22 04:18:11.028566) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-09-22 04:18:11.028898) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:18:11 INFO - MultiFileLogger online at 20160922 04:18:11 in /builds/slave/test 04:18:11 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 04:18:11 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:18:11 INFO - {'append_to_log': False, 04:18:11 INFO - 'base_work_dir': '/builds/slave/test', 04:18:11 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:18:11 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:18:11 INFO - 'branch': 'Firefox-Non-PGO', 04:18:11 INFO - 'buildbot_json_path': 'buildprops.json', 04:18:11 INFO - 'config_files': ('talos/linux_config.py',), 04:18:11 INFO - 'default_actions': ('clobber', 04:18:11 INFO - 'read-buildbot-config', 04:18:11 INFO - 'download-and-extract', 04:18:11 INFO - 'populate-webroot', 04:18:11 INFO - 'create-virtualenv', 04:18:11 INFO - 'install', 04:18:11 INFO - 'run-tests'), 04:18:11 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:18:11 INFO - 'download_minidump_stackwalk': True, 04:18:11 INFO - 'download_symbols': 'ondemand', 04:18:11 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:18:11 INFO - 'tooltool.py': '/tools/tooltool.py', 04:18:11 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:18:11 INFO - '/tools/misc-python/virtualenv.py')}, 04:18:11 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:18:11 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:18:11 INFO - 'installer_path': 'installer.exe', 04:18:11 INFO - 'log_level': 'info', 04:18:11 INFO - 'log_name': 'talos', 04:18:11 INFO - 'log_to_console': True, 04:18:11 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:18:11 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:18:11 INFO - 'opt_config_files': (), 04:18:11 INFO - 'pip_index': False, 04:18:11 INFO - 'sps_profile': False, 04:18:11 INFO - 'sps_profile_interval': 0, 04:18:11 INFO - 'suite': 'dromaeojs', 04:18:11 INFO - 'system_bits': '32', 04:18:11 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:18:11 INFO - 'title': 'talos-linux64-ix-016', 04:18:11 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:18:11 INFO - 'use_talos_json': True, 04:18:11 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:18:11 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:18:11 INFO - 'work_dir': 'build'} 04:18:11 INFO - [mozharness: 2016-09-22 11:18:11.390565Z] Running clobber step. 04:18:11 INFO - Running pre-action listener: _resource_record_pre_action 04:18:11 INFO - Running main action method: clobber 04:18:11 INFO - rmtree: /builds/slave/test/build 04:18:11 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:18:11 INFO - Running post-action listener: _resource_record_post_action 04:18:11 INFO - [mozharness: 2016-09-22 11:18:11.840582Z] Finished clobber step (success) 04:18:11 INFO - [mozharness: 2016-09-22 11:18:11.840682Z] Running read-buildbot-config step. 04:18:11 INFO - Running pre-action listener: _resource_record_pre_action 04:18:11 INFO - Running main action method: read_buildbot_config 04:18:11 INFO - Using buildbot properties: 04:18:11 INFO - { 04:18:11 INFO - "project": "", 04:18:11 INFO - "product": "firefox", 04:18:11 INFO - "script_repo_revision": "production", 04:18:11 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 04:18:11 INFO - "repository": "", 04:18:11 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 04:18:11 INFO - "buildid": "20160922025602", 04:18:11 INFO - "pgo_build": "False", 04:18:11 INFO - "basedir": "/builds/slave/test", 04:18:11 INFO - "buildnumber": 753, 04:18:11 INFO - "slavename": "talos-linux64-ix-016", 04:18:11 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 04:18:11 INFO - "platform": "ubuntu64_hw", 04:18:11 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 04:18:11 INFO - "branch": "mozilla-central", 04:18:11 INFO - "repo_path": "mozilla-central", 04:18:11 INFO - "revision": "f0e6cc6360213ba21fd98c887b55fce5c680df68", 04:18:11 INFO - "stage_platform": "linux64", 04:18:11 INFO - "builduid": "dd3494223b1a41a3b5452fee039acf5b", 04:18:11 INFO - "slavebuilddir": "test" 04:18:11 INFO - } 04:18:11 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 04:18:11 INFO - Running post-action listener: _resource_record_post_action 04:18:11 INFO - [mozharness: 2016-09-22 11:18:11.843129Z] Finished read-buildbot-config step (success) 04:18:11 INFO - [mozharness: 2016-09-22 11:18:11.843217Z] Running download-and-extract step. 04:18:11 INFO - Running pre-action listener: _resource_record_pre_action 04:18:11 INFO - Running main action method: download_and_extract 04:18:11 INFO - mkdir: /builds/slave/test/build/tests 04:18:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:18:11 INFO - trying https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 04:18:11 INFO - Downloading https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/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 04:18:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/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 04:18:12 INFO - Downloaded 1361 bytes. 04:18:12 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 04:18:12 INFO - Using the following test package requirements: 04:18:12 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 04:18:12 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:18:12 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 04:18:12 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'jsshell-linux-x86_64.zip'], 04:18:12 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:18:12 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 04:18:12 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:18:12 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:18:12 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:18:12 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:18:12 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:18:12 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:18:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 04:18:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:18:12 INFO - Fetch https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 04:18:12 INFO - Expected file size: 20372757 04:18:17 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 04:18:17 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 04:18:17 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:18:17 INFO - Fetch https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 04:18:17 INFO - Expected file size: 20372757 04:18:22 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 04:18:22 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:18:22 INFO - Fetch https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 04:18:23 INFO - Expected file size: 14414059 04:18: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')]} 04:18:24 INFO - trying https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 04:18:24 INFO - Downloading https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/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 04:18:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/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 04:18:26 INFO - Downloaded 55713305 bytes. 04:18:26 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 04:18:26 INFO - mkdir: /builds/slave/test/properties 04:18:26 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:18:26 INFO - Writing to file /builds/slave/test/properties/build_url 04:18:26 INFO - Contents: 04:18:26 INFO - build_url:https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 04:18:27 INFO - Running post-action listener: _resource_record_post_action 04:18:27 INFO - Running post-action listener: set_extra_try_arguments 04:18:27 INFO - [mozharness: 2016-09-22 11:18:27.377855Z] Finished download-and-extract step (success) 04:18:27 INFO - [mozharness: 2016-09-22 11:18:27.378083Z] Running populate-webroot step. 04:18:27 INFO - Running pre-action listener: _resource_record_pre_action 04:18:27 INFO - Running main action method: populate_webroot 04:18:27 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:18:27 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:18:27 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:18:27 INFO - '--tppagecycles', 04:18:27 INFO - '7'], 04:18:27 INFO - 'tests': ['tsvgm']}}, 04:18:27 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:18:27 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:18:27 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:18:27 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:18:27 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:18:27 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:18:27 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['damp', 'tps']}, 04:18:27 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'tests': ['damp', 'tps']}, 04:18:27 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['dromaeo_dom']}, 04:18:27 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:18:27 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['basic_compositor_video']}, 04:18:27 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:18:27 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['a11yr', 04:18:27 INFO - 'ts_paint', 04:18:27 INFO - 'tpaint', 04:18:27 INFO - 'sessionrestore', 04:18:27 INFO - 'sessionrestore_no_auto_restore', 04:18:27 INFO - 'tabpaint']}, 04:18:27 INFO - 'other-e10s': {'tests': ['a11yr', 04:18:27 INFO - 'ts_paint', 04:18:27 INFO - 'tpaint', 04:18:27 INFO - 'sessionrestore', 04:18:27 INFO - 'sessionrestore_no_auto_restore', 04:18:27 INFO - 'tabpaint']}, 04:18:27 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:18:27 INFO - 'ts_paint', 04:18:27 INFO - 'tpaint', 04:18:27 INFO - 'sessionrestore', 04:18:27 INFO - 'sessionrestore_no_auto_restore', 04:18:27 INFO - 'tabpaint']}, 04:18:27 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:18:27 INFO - 'ts_paint', 04:18:27 INFO - 'tpaint', 04:18:27 INFO - 'sessionrestore', 04:18:27 INFO - 'sessionrestore_no_auto_restore', 04:18:27 INFO - 'tabpaint']}, 04:18:27 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['a11yr', 04:18:27 INFO - 'ts_paint', 04:18:27 INFO - 'tpaint', 04:18:27 INFO - 'sessionrestore', 04:18:27 INFO - 'sessionrestore_no_auto_restore', 04:18:27 INFO - 'tabpaint']}, 04:18:27 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['a11yr', 04:18:27 INFO - 'ts_paint', 04:18:27 INFO - 'tpaint', 04:18:27 INFO - 'sessionrestore', 04:18:27 INFO - 'sessionrestore_no_auto_restore', 04:18:27 INFO - 'tabpaint']}, 04:18:27 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['tsvgx', 04:18:27 INFO - 'tsvgr_opacity', 04:18:27 INFO - 'tart', 04:18:27 INFO - 'tscrollx', 04:18:27 INFO - 'cart']}, 04:18:27 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:18:27 INFO - 'tsvgr_opacity', 04:18:27 INFO - 'tart', 04:18:27 INFO - 'tscrollx', 04:18:27 INFO - 'cart']}, 04:18:27 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'talos_options': ['--disable-e10s'], 04:18:27 INFO - 'tests': ['tp5o']}, 04:18:27 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'tests': ['tp5o']}, 04:18:27 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'talos_options': ['--disable-e10s', 04:18:27 INFO - '--xperf_path', 04:18:27 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:18:27 INFO - 'tests': ['tp5n']}, 04:18:27 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:18:27 INFO - 'talos_options': ['--xperf_path', 04:18:27 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:18:27 INFO - 'tests': ['tp5n']}}, 04:18:27 INFO - 'talos.zip': {'path': '', 04:18:27 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:18:27 INFO - Running post-action listener: _resource_record_post_action 04:18:27 INFO - [mozharness: 2016-09-22 11:18:27.396116Z] Finished populate-webroot step (success) 04:18:27 INFO - [mozharness: 2016-09-22 11:18:27.396205Z] Running create-virtualenv step. 04:18:27 INFO - Running pre-action listener: _resource_record_pre_action 04:18:27 INFO - Running main action method: create_virtualenv 04:18:27 INFO - Creating virtualenv /builds/slave/test/build/venv 04:18:27 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 04:18:27 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:18:27 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:18:27 INFO - Using real prefix '/usr' 04:18:27 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:18:27 INFO - Installing distribute.............................................................................................................................................................................................done. 04:18:29 INFO - Installing pip.................done. 04:18:29 INFO - Return code: 0 04:18:29 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:18:29 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')]} 04:18:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:29 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')]} 04:18:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:29 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:29 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 04:18:29 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 04:18:29 INFO - Using env: {'DISPLAY': ':0', 04:18:29 INFO - 'HOME': '/home/cltbld', 04:18:29 INFO - 'LANG': 'en_US.UTF-8', 04:18:29 INFO - 'LANGUAGE': 'en_US:en', 04:18:29 INFO - 'LOGNAME': 'cltbld', 04:18:29 INFO - 'MAIL': '/var/mail/cltbld', 04:18:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:29 INFO - 'MOZ_NO_REMOTE': '1', 04:18:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:29 INFO - 'NO_EM_RESTART': '1', 04:18:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:29 INFO - 'PWD': '/builds/slave/test', 04:18:29 INFO - 'SHELL': '/bin/bash', 04:18:29 INFO - 'SHLVL': '1', 04:18:29 INFO - 'TERM': 'linux', 04:18:29 INFO - 'TMOUT': '86400', 04:18:29 INFO - 'USER': 'cltbld', 04:18:29 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:29 INFO - '_': '/tools/buildbot/bin/python'} 04:18:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:30 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 04:18:30 INFO - Cleaning up... 04:18:30 INFO - Return code: 0 04:18:30 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:18:30 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')]} 04:18:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:30 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')]} 04:18:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:30 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:30 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 04:18:30 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 04:18:30 INFO - Using env: {'DISPLAY': ':0', 04:18:30 INFO - 'HOME': '/home/cltbld', 04:18:30 INFO - 'LANG': 'en_US.UTF-8', 04:18:30 INFO - 'LANGUAGE': 'en_US:en', 04:18:30 INFO - 'LOGNAME': 'cltbld', 04:18:30 INFO - 'MAIL': '/var/mail/cltbld', 04:18:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:30 INFO - 'MOZ_NO_REMOTE': '1', 04:18:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:30 INFO - 'NO_EM_RESTART': '1', 04:18:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:30 INFO - 'PWD': '/builds/slave/test', 04:18:30 INFO - 'SHELL': '/bin/bash', 04:18:30 INFO - 'SHLVL': '1', 04:18:30 INFO - 'TERM': 'linux', 04:18:30 INFO - 'TMOUT': '86400', 04:18:30 INFO - 'USER': 'cltbld', 04:18:30 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:30 INFO - '_': '/tools/buildbot/bin/python'} 04:18:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:30 INFO - Downloading/unpacking psutil>=3.1.1 04:18:30 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 04:18:30 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 04:18:30 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 04:18:30 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 04:18:30 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 04:18:30 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 04:18:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:18:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:18:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:18:32 INFO - Installing collected packages: psutil 04:18:32 INFO - Running setup.py install for psutil 04:18:32 INFO - building 'psutil._psutil_linux' extension 04:18:32 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 04:18:32 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 04:18:32 INFO - building 'psutil._psutil_posix' extension 04:18:32 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 04:18:32 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 04:18:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:18:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:18:32 INFO - Successfully installed psutil 04:18:32 INFO - Cleaning up... 04:18:32 INFO - Return code: 0 04:18:32 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:18:32 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')]} 04:18:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:32 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')]} 04:18:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:32 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:32 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 04:18:32 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 04:18:32 INFO - Using env: {'DISPLAY': ':0', 04:18:32 INFO - 'HOME': '/home/cltbld', 04:18:32 INFO - 'LANG': 'en_US.UTF-8', 04:18:32 INFO - 'LANGUAGE': 'en_US:en', 04:18:32 INFO - 'LOGNAME': 'cltbld', 04:18:32 INFO - 'MAIL': '/var/mail/cltbld', 04:18:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:32 INFO - 'MOZ_NO_REMOTE': '1', 04:18:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:32 INFO - 'NO_EM_RESTART': '1', 04:18:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:32 INFO - 'PWD': '/builds/slave/test', 04:18:32 INFO - 'SHELL': '/bin/bash', 04:18:32 INFO - 'SHLVL': '1', 04:18:32 INFO - 'TERM': 'linux', 04:18:32 INFO - 'TMOUT': '86400', 04:18:32 INFO - 'USER': 'cltbld', 04:18:32 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:32 INFO - '_': '/tools/buildbot/bin/python'} 04:18:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:33 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:18: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 04:18: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 04:18: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 04:18: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 04:18: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 04:18: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 04:18:35 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:18:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:18:35 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:18:35 INFO - Installing collected packages: mozsystemmonitor 04:18:35 INFO - Running setup.py install for mozsystemmonitor 04:18:35 INFO - Successfully installed mozsystemmonitor 04:18:35 INFO - Cleaning up... 04:18:35 INFO - Return code: 0 04:18:35 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:18: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')]} 04:18:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18: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')]} 04:18:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18: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==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18: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==2.5.1'] in /builds/slave/test/build 04:18: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==2.5.1 04:18:35 INFO - Using env: {'DISPLAY': ':0', 04:18:35 INFO - 'HOME': '/home/cltbld', 04:18:35 INFO - 'LANG': 'en_US.UTF-8', 04:18:35 INFO - 'LANGUAGE': 'en_US:en', 04:18:35 INFO - 'LOGNAME': 'cltbld', 04:18:35 INFO - 'MAIL': '/var/mail/cltbld', 04:18:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:35 INFO - 'MOZ_NO_REMOTE': '1', 04:18:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:35 INFO - 'NO_EM_RESTART': '1', 04:18:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:35 INFO - 'PWD': '/builds/slave/test', 04:18:35 INFO - 'SHELL': '/bin/bash', 04:18:35 INFO - 'SHLVL': '1', 04:18:35 INFO - 'TERM': 'linux', 04:18:35 INFO - 'TMOUT': '86400', 04:18:35 INFO - 'USER': 'cltbld', 04:18:35 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:35 INFO - '_': '/tools/buildbot/bin/python'} 04:18:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:35 INFO - Downloading/unpacking jsonschema==2.5.1 04:18:35 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 04:18:35 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 04:18:35 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 04:18:35 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 04:18:35 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 04:18:35 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 04:18:37 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:18:37 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:18:37 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 04:18:37 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 04:18:37 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 04:18:37 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 04:18:37 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 04:18:37 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 04:18:37 INFO - Downloading functools32-3.2.3-2.tar.gz 04:18:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:18:37 INFO - warning: no files found matching '*.txt' 04:18:37 INFO - no previously-included directories found matching 'build' 04:18:37 INFO - no previously-included directories found matching 'dist' 04:18:37 INFO - no previously-included directories found matching '.git*' 04:18:37 INFO - Installing collected packages: jsonschema, functools32 04:18:37 INFO - Running setup.py install for functools32 04:18:37 INFO - warning: no files found matching '*.txt' 04:18:37 INFO - no previously-included directories found matching 'build' 04:18:37 INFO - no previously-included directories found matching 'dist' 04:18:37 INFO - no previously-included directories found matching '.git*' 04:18:37 INFO - Successfully installed jsonschema functools32 04:18:37 INFO - Cleaning up... 04:18:37 INFO - Return code: 0 04:18:37 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:18:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:18:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:18:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:37 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:37 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 04:18:37 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 04:18:37 INFO - Using env: {'DISPLAY': ':0', 04:18:37 INFO - 'HOME': '/home/cltbld', 04:18:37 INFO - 'LANG': 'en_US.UTF-8', 04:18:37 INFO - 'LANGUAGE': 'en_US:en', 04:18:37 INFO - 'LOGNAME': 'cltbld', 04:18:37 INFO - 'MAIL': '/var/mail/cltbld', 04:18:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:37 INFO - 'MOZ_NO_REMOTE': '1', 04:18:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:37 INFO - 'NO_EM_RESTART': '1', 04:18:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:37 INFO - 'PWD': '/builds/slave/test', 04:18:37 INFO - 'SHELL': '/bin/bash', 04:18:37 INFO - 'SHLVL': '1', 04:18:37 INFO - 'TERM': 'linux', 04:18:37 INFO - 'TMOUT': '86400', 04:18:37 INFO - 'USER': 'cltbld', 04:18:37 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:37 INFO - '_': '/tools/buildbot/bin/python'} 04:18:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:38 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:18:38 INFO - Cleaning up... 04:18:38 INFO - Return code: 0 04:18:38 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:18:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:18:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:18:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:38 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:38 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 04:18:38 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 04:18:38 INFO - Using env: {'DISPLAY': ':0', 04:18:38 INFO - 'HOME': '/home/cltbld', 04:18:38 INFO - 'LANG': 'en_US.UTF-8', 04:18:38 INFO - 'LANGUAGE': 'en_US:en', 04:18:38 INFO - 'LOGNAME': 'cltbld', 04:18:38 INFO - 'MAIL': '/var/mail/cltbld', 04:18:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:38 INFO - 'MOZ_NO_REMOTE': '1', 04:18:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:38 INFO - 'NO_EM_RESTART': '1', 04:18:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:38 INFO - 'PWD': '/builds/slave/test', 04:18:38 INFO - 'SHELL': '/bin/bash', 04:18:38 INFO - 'SHLVL': '1', 04:18:38 INFO - 'TERM': 'linux', 04:18:38 INFO - 'TMOUT': '86400', 04:18:38 INFO - 'USER': 'cltbld', 04:18:38 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:38 INFO - '_': '/tools/buildbot/bin/python'} 04:18:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:38 INFO - Downloading/unpacking blobuploader==1.2.4 04:18:38 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 04:18:38 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 04:18:38 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 04:18:38 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 04:18:38 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 04:18:38 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 04:18:40 INFO - Downloading blobuploader-1.2.4.tar.gz 04:18:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:18:40 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:18:40 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 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 04:18:40 INFO - Downloading docopt-0.6.1.tar.gz 04:18:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:18:40 INFO - Installing collected packages: blobuploader, requests, docopt 04:18:40 INFO - Running setup.py install for blobuploader 04:18:41 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:18:41 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:18:41 INFO - Running setup.py install for requests 04:18:41 INFO - Running setup.py install for docopt 04:18:41 INFO - Successfully installed blobuploader requests docopt 04:18:41 INFO - Cleaning up... 04:18:41 INFO - Return code: 0 04:18:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:18:41 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')]} 04:18:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:41 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')]} 04:18:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:41 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:41 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 04:18:41 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 04:18:41 INFO - Using env: {'DISPLAY': ':0', 04:18:41 INFO - 'HOME': '/home/cltbld', 04:18:41 INFO - 'LANG': 'en_US.UTF-8', 04:18:41 INFO - 'LANGUAGE': 'en_US:en', 04:18:41 INFO - 'LOGNAME': 'cltbld', 04:18:41 INFO - 'MAIL': '/var/mail/cltbld', 04:18:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:41 INFO - 'MOZ_NO_REMOTE': '1', 04:18:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:41 INFO - 'NO_EM_RESTART': '1', 04:18:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:41 INFO - 'PWD': '/builds/slave/test', 04:18:41 INFO - 'SHELL': '/bin/bash', 04:18:41 INFO - 'SHLVL': '1', 04:18:41 INFO - 'TERM': 'linux', 04:18:41 INFO - 'TMOUT': '86400', 04:18:41 INFO - 'USER': 'cltbld', 04:18:41 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:41 INFO - '_': '/tools/buildbot/bin/python'} 04:18:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:18:41 INFO - Running setup.py (path:/tmp/pip-QZk1N7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:18:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:18:41 INFO - Running setup.py (path:/tmp/pip-5i2Ok_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:18:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:18:41 INFO - Running setup.py (path:/tmp/pip-Nxdi68-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:18:42 INFO - Running setup.py (path:/tmp/pip-qeLUC6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:18:42 INFO - Running setup.py (path:/tmp/pip-To6oJK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:18:42 INFO - Running setup.py (path:/tmp/pip-iBxbeW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:18:42 INFO - Running setup.py (path:/tmp/pip-R7JY0l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:18:42 INFO - Running setup.py (path:/tmp/pip-7EoM4b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:18:42 INFO - Running setup.py (path:/tmp/pip-JvRP6i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:18:42 INFO - Running setup.py (path:/tmp/pip-UHa2Ag-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:18:42 INFO - Running setup.py (path:/tmp/pip-2C5KfU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:18:42 INFO - Running setup.py (path:/tmp/pip-fFGJjd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:18:42 INFO - Running setup.py (path:/tmp/pip-KCzfG8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:18:42 INFO - Running setup.py (path:/tmp/pip-u1vSF7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:18:42 INFO - Running setup.py (path:/tmp/pip-LGvG_a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:18:42 INFO - Running setup.py (path:/tmp/pip-QAkyIo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:18:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:18:42 INFO - Running setup.py (path:/tmp/pip-REqPf7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:18:43 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:18:43 INFO - Running setup.py install for manifestparser 04:18:43 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Running setup.py install for mozcrash 04:18:43 INFO - Running setup.py install for mozdebug 04:18:43 INFO - Running setup.py install for mozdevice 04:18:43 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Running setup.py install for mozfile 04:18:43 INFO - Running setup.py install for mozhttpd 04:18:43 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Running setup.py install for mozinfo 04:18:43 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Running setup.py install for mozInstall 04:18:43 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:18:43 INFO - Running setup.py install for mozleak 04:18:43 INFO - Running setup.py install for mozlog 04:18:44 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:18:44 INFO - Running setup.py install for moznetwork 04:18:44 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:18:44 INFO - Running setup.py install for mozprocess 04:18:44 INFO - Running setup.py install for mozprofile 04:18:44 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:18:44 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:18:44 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:18:44 INFO - Running setup.py install for mozrunner 04:18:44 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:18:44 INFO - Running setup.py install for mozscreenshot 04:18:44 INFO - Running setup.py install for moztest 04:18:44 INFO - Running setup.py install for mozversion 04:18:44 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:18:44 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:18:44 INFO - Cleaning up... 04:18:44 INFO - Return code: 0 04:18:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:18:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:18:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:18:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:44 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:44 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 04:18:44 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 04:18:44 INFO - Using env: {'DISPLAY': ':0', 04:18:44 INFO - 'HOME': '/home/cltbld', 04:18:44 INFO - 'LANG': 'en_US.UTF-8', 04:18:44 INFO - 'LANGUAGE': 'en_US:en', 04:18:44 INFO - 'LOGNAME': 'cltbld', 04:18:44 INFO - 'MAIL': '/var/mail/cltbld', 04:18:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:44 INFO - 'MOZ_NO_REMOTE': '1', 04:18:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:44 INFO - 'NO_EM_RESTART': '1', 04:18:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:44 INFO - 'PWD': '/builds/slave/test', 04:18:44 INFO - 'SHELL': '/bin/bash', 04:18:44 INFO - 'SHLVL': '1', 04:18:44 INFO - 'TERM': 'linux', 04:18:44 INFO - 'TMOUT': '86400', 04:18:44 INFO - 'USER': 'cltbld', 04:18:44 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:44 INFO - '_': '/tools/buildbot/bin/python'} 04:18:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:18:45 INFO - Running setup.py (path:/tmp/pip-OeqksN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:18:45 INFO - Running setup.py (path:/tmp/pip-qg_Sgz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:18:45 INFO - Running setup.py (path:/tmp/pip-bqzrur-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:18:45 INFO - Running setup.py (path:/tmp/pip-2FA5kl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:18:45 INFO - Running setup.py (path:/tmp/pip-G8EEVr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:18:45 INFO - Running setup.py (path:/tmp/pip-ph3ZwN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:18:45 INFO - Running setup.py (path:/tmp/pip-KZ4Nuw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:18:45 INFO - Running setup.py (path:/tmp/pip-8y5SrM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:18:45 INFO - Running setup.py (path:/tmp/pip-HBiGu5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:18:45 INFO - Running setup.py (path:/tmp/pip-JoKvOY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:18:45 INFO - Running setup.py (path:/tmp/pip-AaWqg2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:18:45 INFO - Running setup.py (path:/tmp/pip-yUpgae-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:18:45 INFO - Running setup.py (path:/tmp/pip-4sEA79-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:18:45 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)) 04:18:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:18:45 INFO - Running setup.py (path:/tmp/pip-5_qXkt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:18:46 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)) 04:18:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:18:46 INFO - Running setup.py (path:/tmp/pip-kloGLp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:18:46 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)) 04:18:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:18:46 INFO - Running setup.py (path:/tmp/pip-SCaiWa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:18:46 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)) 04:18:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:18:46 INFO - Running setup.py (path:/tmp/pip-0zapli-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:18:46 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)) 04:18:46 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)) 04:18:46 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)) 04:18:46 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)) 04:18:46 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)) 04:18:46 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)) 04:18:46 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:18:46 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 04:18:46 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 04:18:46 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 04:18:46 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 04:18:46 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 04:18:46 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 04:18:48 INFO - Downloading blessings-1.6.tar.gz 04:18:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:18:48 INFO - Installing collected packages: blessings 04:18:48 INFO - Running setup.py install for blessings 04:18:48 INFO - Successfully installed blessings 04:18:48 INFO - Cleaning up... 04:18:48 INFO - Return code: 0 04:18:48 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:18:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:18:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:18:48 INFO - Reading from file tmpfile_stdout 04:18:48 INFO - Current package versions: 04:18:48 INFO - argparse == 1.2.1 04:18:48 INFO - blessings == 1.6 04:18:48 INFO - blobuploader == 1.2.4 04:18:48 INFO - docopt == 0.6.1 04:18:48 INFO - functools32 == 3.2.3-2 04:18:48 INFO - jsonschema == 2.5.1 04:18:48 INFO - manifestparser == 1.1 04:18:48 INFO - mozInstall == 1.12 04:18:48 INFO - mozcrash == 0.17 04:18:48 INFO - mozdebug == 0.1 04:18:48 INFO - mozdevice == 0.48 04:18:48 INFO - mozfile == 1.2 04:18:48 INFO - mozhttpd == 0.7 04:18:48 INFO - mozinfo == 0.9 04:18:48 INFO - mozleak == 0.1 04:18:48 INFO - mozlog == 3.4 04:18:48 INFO - moznetwork == 0.27 04:18:48 INFO - mozprocess == 0.23 04:18:48 INFO - mozprofile == 0.28 04:18:48 INFO - mozrunner == 6.12 04:18:48 INFO - mozscreenshot == 0.1 04:18:48 INFO - mozsystemmonitor == 0.3 04:18:48 INFO - moztest == 0.7 04:18:48 INFO - mozversion == 1.4 04:18:48 INFO - psutil == 3.1.1 04:18:48 INFO - requests == 1.2.3 04:18:48 INFO - wsgiref == 0.1.2 04:18:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:18:48 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')]} 04:18:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:48 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')]} 04:18:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:48 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:48 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 04:18:48 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 04:18:48 INFO - Using env: {'DISPLAY': ':0', 04:18:48 INFO - 'HOME': '/home/cltbld', 04:18:48 INFO - 'LANG': 'en_US.UTF-8', 04:18:48 INFO - 'LANGUAGE': 'en_US:en', 04:18:48 INFO - 'LOGNAME': 'cltbld', 04:18:48 INFO - 'MAIL': '/var/mail/cltbld', 04:18:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:48 INFO - 'MOZ_NO_REMOTE': '1', 04:18:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:48 INFO - 'NO_EM_RESTART': '1', 04:18:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:48 INFO - 'PWD': '/builds/slave/test', 04:18:48 INFO - 'SHELL': '/bin/bash', 04:18:48 INFO - 'SHLVL': '1', 04:18:48 INFO - 'TERM': 'linux', 04:18:48 INFO - 'TMOUT': '86400', 04:18:48 INFO - 'USER': 'cltbld', 04:18:48 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:48 INFO - '_': '/tools/buildbot/bin/python'} 04:18:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 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)) 04:18:48 INFO - Cleaning up... 04:18:48 INFO - Return code: 0 04:18:48 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:18:48 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')]} 04:18:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:18:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:48 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')]} 04:18:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:18:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:18:48 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 0x7fc11c86ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10ecca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, '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': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', '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 04:18:48 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 04:18:48 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 04:18:48 INFO - Using env: {'DISPLAY': ':0', 04:18:48 INFO - 'HOME': '/home/cltbld', 04:18:48 INFO - 'LANG': 'en_US.UTF-8', 04:18:48 INFO - 'LANGUAGE': 'en_US:en', 04:18:48 INFO - 'LOGNAME': 'cltbld', 04:18:48 INFO - 'MAIL': '/var/mail/cltbld', 04:18:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:18:48 INFO - 'MOZ_NO_REMOTE': '1', 04:18:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:18:48 INFO - 'NO_EM_RESTART': '1', 04:18:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:18:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:18:48 INFO - 'PWD': '/builds/slave/test', 04:18:48 INFO - 'SHELL': '/bin/bash', 04:18:48 INFO - 'SHLVL': '1', 04:18:48 INFO - 'TERM': 'linux', 04:18:48 INFO - 'TMOUT': '86400', 04:18:48 INFO - 'USER': 'cltbld', 04:18:48 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:18:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:18:48 INFO - '_': '/tools/buildbot/bin/python'} 04:18:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:18:49 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:18:49 INFO - Cleaning up... 04:18:49 INFO - Return code: 0 04:18:49 INFO - Running post-action listener: _resource_record_post_action 04:18:49 INFO - Running post-action listener: _start_resource_monitoring 04:18:49 INFO - Starting resource monitoring. 04:18:49 INFO - [mozharness: 2016-09-22 11:18:49.106857Z] Finished create-virtualenv step (success) 04:18:49 INFO - [mozharness: 2016-09-22 11:18:49.107315Z] Running install step. 04:18:49 INFO - Running pre-action listener: _resource_record_pre_action 04:18:49 INFO - Running main action method: install 04:18:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:18:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:18:49 INFO - Reading from file tmpfile_stdout 04:18:49 INFO - Detecting whether we're running mozinstall >=1.0... 04:18:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:18:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:18:49 INFO - Reading from file tmpfile_stdout 04:18:49 INFO - Output received: 04:18:49 INFO - Usage: mozinstall [options] installer 04:18:49 INFO - Options: 04:18:49 INFO - -h, --help show this help message and exit 04:18:49 INFO - -d DEST, --destination=DEST 04:18:49 INFO - Directory to install application into. [default: 04:18:49 INFO - "/builds/slave/test"] 04:18:49 INFO - --app=APP Application being installed. [default: firefox] 04:18:49 INFO - mkdir: /builds/slave/test/build/application 04:18:49 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'] 04:18:49 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 04:19:06 INFO - Reading from file tmpfile_stdout 04:19:06 INFO - Output received: 04:19:06 INFO - /builds/slave/test/build/application/firefox/firefox 04:19:06 INFO - Running post-action listener: _resource_record_post_action 04:19:06 INFO - [mozharness: 2016-09-22 11:19:06.057247Z] Finished install step (success) 04:19:06 INFO - [mozharness: 2016-09-22 11:19:06.057546Z] Running run-tests step. 04:19:06 INFO - Running pre-action listener: _resource_record_pre_action 04:19:06 INFO - Running main action method: run_tests 04:19:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:19:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:19:06 INFO - Python 2.7.3 04:19:06 INFO - Return code: 0 04:19:06 INFO - grabbing minidump binary from tooltool 04:19:06 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')]} 04:19:06 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 0x10e9f60>, '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 0x10ead40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10eb1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:19:06 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 04:19:06 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 04:19:06 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 04:19:06 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:19:06 INFO - Return code: 0 04:19:06 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:19:06 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:19:06 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:19:06 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:19:06 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:19:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 04:19:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-016 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 04:19:06 INFO - Using env: {'DISPLAY': ':0', 04:19:06 INFO - 'HOME': '/home/cltbld', 04:19:06 INFO - 'LANG': 'en_US.UTF-8', 04:19:06 INFO - 'LANGUAGE': 'en_US:en', 04:19:06 INFO - 'LOGNAME': 'cltbld', 04:19:06 INFO - 'MAIL': '/var/mail/cltbld', 04:19:06 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:19:06 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:19:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:19:06 INFO - 'MOZ_NO_REMOTE': '1', 04:19:06 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:19:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:19:06 INFO - 'NO_EM_RESTART': '1', 04:19:06 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:19:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:19:06 INFO - 'PWD': '/builds/slave/test', 04:19:06 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:19:06 INFO - 'SHELL': '/bin/bash', 04:19:06 INFO - 'SHLVL': '1', 04:19:06 INFO - 'TERM': 'linux', 04:19:06 INFO - 'TMOUT': '86400', 04:19:06 INFO - 'USER': 'cltbld', 04:19:06 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972', 04:19:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:19:06 INFO - '_': '/tools/buildbot/bin/python'} 04:19:06 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 04:19:06 INFO - mozversion application_buildid: 20160922025602 04:19:06 INFO - mozversion application_changeset: f0e6cc6360213ba21fd98c887b55fce5c680df68 04:19:06 INFO - mozversion application_display_name: Nightly 04:19:06 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:19:06 INFO - mozversion application_name: Firefox 04:19:06 INFO - mozversion application_remotingname: firefox 04:19:06 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:19:06 INFO - mozversion application_vendor: Mozilla 04:19:06 INFO - mozversion application_version: 52.0a1 04:19:06 INFO - mozversion platform_buildid: 20160922025602 04:19:06 INFO - mozversion platform_changeset: f0e6cc6360213ba21fd98c887b55fce5c680df68 04:19:06 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:19:06 INFO - mozversion platform_version: 52.0a1 04:19:06 INFO - using testdate: 1474543146 04:19:06 INFO - actual date: 1474543146 04:19:06 INFO - starting webserver on 'localhost:34384' 04:19:06 INFO - SUITE-START | Running 2 tests 04:19:06 INFO - TEST-START | dromaeo_css 04:19:06 INFO - operating with platform_type : linux_ 04:19:06 INFO - Initialising browser for dromaeo_css test... 04:19:06 INFO - TEST-INFO | started process 12317 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpoeUssE/profile http://localhost:34384/getInfo.html) 04:19:11 INFO - PROCESS | 12317 | __metrics Screen width/height:1600/1200 04:19:11 INFO - PROCESS | 12317 | colorDepth:24 04:19:11 INFO - PROCESS | 12317 | Browser inner width/height: 1024/697 04:19:11 INFO - PROCESS | 12317 | __metrics 04:19:11 INFO - PROCESS | 12317 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:19:11 INFO - PROCESS | 12317 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:19:12 INFO - PROCESS | 12317 | console.error: PushService: 04:19:12 INFO - PROCESS | 12317 | stateChangeProcessEnqueue: Error transitioning state 04:19:12 INFO - PROCESS | 12317 | UnknownError 04:19:13 INFO - TEST-INFO | 12317: exit 0 04:19:13 INFO - Browser initialized. 04:19:13 INFO - Running cycle 1/1 for dromaeo_css test... 04:19:13 INFO - TEST-INFO | started process 12398 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpoeUssE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:19:25 INFO - PROCESS | 12398 | RSS: Main: 175681536 04:19:25 INFO - PROCESS | 12398 | 04:20:16 INFO - PROCESS | 12398 | 1474543216881 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] 04:22:29 INFO - PROCESS | 12398 | Cycle 1(1): loaded http://localhost:34384/tests/dromaeo/cssquery-dojo.html (next: http://localhost:34384/tests/dromaeo/cssquery-ext.html) 04:22:30 INFO - PROCESS | 12398 | RSS: Main: 316284928 04:22:30 INFO - PROCESS | 12398 | 04:25:33 INFO - PROCESS | 12398 | Cycle 1(1): loaded http://localhost:34384/tests/dromaeo/cssquery-ext.html (next: http://localhost:34384/tests/dromaeo/cssquery-jquery.html) 04:25:33 INFO - PROCESS | 12398 | RSS: Main: 278372352 04:25:33 INFO - PROCESS | 12398 | 04:28:35 INFO - PROCESS | 12398 | Cycle 1(1): loaded http://localhost:34384/tests/dromaeo/cssquery-jquery.html (next: http://localhost:34384/tests/dromaeo/cssquery-mootools.html) 04:28:36 INFO - PROCESS | 12398 | RSS: Main: 260825088 04:28:36 INFO - PROCESS | 12398 | 04:31:38 INFO - PROCESS | 12398 | Cycle 1(1): loaded http://localhost:34384/tests/dromaeo/cssquery-mootools.html (next: http://localhost:34384/tests/dromaeo/cssquery-prototype.html) 04:31:39 INFO - PROCESS | 12398 | RSS: Main: 225234944 04:31:39 INFO - PROCESS | 12398 | 04:34:42 INFO - PROCESS | 12398 | Cycle 1(1): loaded http://localhost:34384/tests/dromaeo/cssquery-prototype.html (next: http://localhost:34384/tests/dromaeo/cssquery-yui.html) 04:34:43 INFO - PROCESS | 12398 | RSS: Main: 220700672 04:34:43 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | Cycle 1(1): loaded http://localhost:34384/tests/dromaeo/cssquery-yui.html (next: http://localhost:34384/tests/dromaeo/cssquery-dojo.html) 04:37:46 INFO - PROCESS | 12398 | RSS: Main: 305377280 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | __start_tp_report 04:37:46 INFO - PROCESS | 12398 | _x_x_mozilla_page_load 04:37:46 INFO - PROCESS | 12398 | _x_x_mozilla_page_load_details 04:37:46 INFO - PROCESS | 12398 | |i|pagename|runs| 04:37:46 INFO - PROCESS | 12398 | |0;dojo.html;2563.320720009198;2589.9352516187105;2604.361931326825;2616.8691565421736;2636.78905687545;4428.911421771562;4489.2817149256125;4641.651876109293;4650.0467404182145;4658.091672123933;4514.390557274775;4598.70108442951;4603.424571928509;4610.0549387375595;4627.583517483426;4182.769947652878;4209.621134097931;4242.618164365206;4248.341507066394;4321.092570560186;4224.366345048236;4284.850030248942;4310.181065597542;4313.180495705821;4369.3227549729845;4091.2431200227757;4112.588741125894;4119.97940010301;4268.935965960513;4282.164977829325;4156.709030367875;4173.52004519478;4176;4179.2059508693255;4184.14225083857;4149.522804877448;4151.107511884929;4153.086321009373;4153.7300075494995;4157.729747566398;4559.110973360196;4674.041821426634;4683.765811709435;4738.905221895578;4747;4972.5276098770555;4973;4983.676061056056;4985.700857948535;5048.368953880765;5002.99940011999;5005.74971251436;5009.023240468074;5016.573591244749;5073.822416215452;4492.573205545468;4541.613962813165;4543.727376357429;4588.7935042923145;4628.305754136906;5073.492650734971;5090.796368145307;5126.231065340229;5132;5133.922991155136;4851.781669824866;4881.121398148296;4888.9755551222015;4891.706497610155;4951.405831300195;4704.294355846582;4946.579540739078;4946.901061978812;4952.257161425815;5010.223415370623;4726.740029298421;4865.829695960624;4882.2432522959;4922.064807686528;5002.924956125661;4889.951100489021;4900.289458028566;4900.362952816111;4904.8773780655765;4963.156263435225;4243.6605071594195;4261.041265715189;4266.040140968257;4271;4317.762523061262;3599.136207310227;3629.1471504196493;3630.2739452109686;3657.798821064867;3661;4254.170436764801;4259.957400425956;4306.418633484503;4307.655387568987;4308.590683885026;4909.091818013679;4920.5571498565305;4923.761118170264;4938.160512712776;4981.975090124599;4138.275801734684;4179.91640167195;4198.6431153352305;4257.850975215914;4257.893552661209;4460.1525710114975;4494.280915053576;4494.977525112419;4530.932036019462;4542.591166795004;4687.906241875212;4689.859304220879;4698.107359601733;4700.741459219776;4737.952620473751;4822.373091498082;4850.46644869057;4928.186849169991;4928.950710492993;4977;4644.535546445329;4677.228257337501;4690.624750020059;4693.436787585511;4729.645276604338;4797.56821886032;4816.133096042746;4827;4843.200871856105;4880.560749532559;4750.453697824794;4915.754212289443;4926.778294976663;4931.605471562195;4985.925211121908;4652.627789776742;4762.214234651244;4768.427788665383;4787.736674482937;4845.781939812788;4781.6891902026255;4791.305260737104;4791.808327666854;4795.20879054952;4850.1269771441475;4734.621230301636;4740.478547359857;4741.193997020446;4744.78648460827;4793.664443488922;4647.395838540968;4697.201475749062;4808.591269742111;4822.590079843112;4828.179209534317;4743.312219728189;4746.216874215854;4748.145333839942;4793.113274044313;4803.447603525639 04:37:46 INFO - PROCESS | 12398 | |1;ext.html;561.0406205388784;571.8827640333732;572.0275531596286;574.870654102827;576.3026737647447;28337.858310708445;29084.854575727117;31115.066548003568;38514.61485385145;39914.8004259979;39053.80473097638;39575.80212098943;39671.603283967226;39680.603193968054;39705.20589588206;7687.2697093776005;7842.294193522582;7851.685932562691;7854.136045035041;7859.29266366027;7691.307782299592;7761.796921477152;7765.301122898938;7778.377729781604;7779.494332868374;7761.534307941513;7808;7812;7813.882791758099;7815.179406162356;7726.111497177841;7739.57432341221;7760.689572417096;7764.922350776476;7767.456278060538;7721.266479684421;7772.3393511551585;7777.261160189773;7778.222177782233;7783.494072885301;36272.63727362746;36592.45111323332;36649.45025824615;36649.81675091634;36702.265954681025;2783.3876547159593;2905.7675385969073;2948.0713575223735;3090.7681923855803;3219.6297425795865;27281.289711708647;27388.58917116245;27957;28056.859715701496;28621.57067643987;3439.7592168548213;3505.0361150683766;3522.084258092889;3538.274653695986;3663.5603727552866;181833;182194;183034;183674.99999999866;184049;50407;50460.74769626202;50466.24300635493;50805.491945080816;50810.237846432334;31374.64690148248;32587.34825303481;32589.185270367958;34179.14552136217;34252.486212706826;13615.727685446236;13685.79471307931;13696.65758356049;13700.177989320673;13723.313834308445;10076.59693612262;10124.443155626512;10199.7450063749;10244.641437549799;10343.327683700536;17577.42986823435;17586.648267034587;17624.559386015197;17632.382866599863;17639.559011024572;6501.349865013461;6533.673316334164;6654.201495820533;6745.9662701686175;6790.388865002074;751.8045308219902;800.917614203079;834.1200033964104;870.4342177584621;907.945523268606;26193.607095893578;27515.58726619102;27709.30726731848;27932.58101128485;28235.294117647223;892.5715656484793;924.7040946897063;966.3477152921749;968.9951550242345;1018.0176130034553;14405.495807646892;14611.488597899022;14671.77992330116;14992.925035374754;15042.646161845487;353922;361397;361717;361784;362295;47778.761106194244;48235;48303.516964829905;48368.75815620899;48382.27426588604;1066.5413872034944;1099.4612639806437;1104.6133853151332;1157.3576664951033;1176.9588064417703;27296.454070918866;28067.859660701564;28805;29077.273068173465;29340.266493337836;40590.18819623532;41158.588414115475;41271.380929286686;41306.586934130275;41322;283349;284055;286134;286318;286709;24246.15138470145;24926.127585534417;24931.501369972862;24973.375665608506;24977.875110625057;37582.24835503329;37681.24637507289;38356.80821595874;39173.21653566856;42001.369979450945;33012.50481242735;35975.64024359723;36322.4551631731;36358.45490815618;36553.81723091474;36100;36142.63857361393;36260.81869590635;36367.63632363643;36694.633053670186;35119.47320790241;35329.1167720809;36119.81940090283;36274.4558831623;36494.81752591326;31148.532772007984;33548;33691.3261734759;33763;34000.489992650626;24174.274771756875;25528.872355638105;26735.732642674102;27084.32289192786;27345.31636709098 04:37:46 INFO - PROCESS | 12398 | |2;jquery.html;337.59151426773604;351.13095089653126;352.39388252206203;359.450041436602;385.387234297467;12038.277703337795;15299.54101376959;16100.75848862268;16143.515694529153;17520;16829.074400907946;16947.83052169481;16957.49127526176;17105.0592217428;17170.055646939414;4084.0810817565957;4932.926006109902;5132.589392848582;5134.306868572751;5158.2004789257535;4928.334674818907;5047.343845300106;5050.141475949097;5050.444451110375;5054.69671819692;4800.207965685658;5010.248462730583;5015.272785446108;5020.548150666439;5020.573251273646;4975.7263350515705;4997.62517811162;5015.072211640858;5015.623828212899;5017.724025178613;4479.126570318789;4480.126375356806;4484.349769283468;4485.484169320504;4692.296155576657;17976;18545.62908741831;19276.710849337273;19524.12141453638;19528;1783.3134243316288;1855.3320804510365;1873.475426880462;1929.411529483507;1947.6883698608297;8382.580870956428;9150.267978561698;9328.207102396305;11829.645110646694;12463.875361246362;1661.5762980440031;1683.4360489236121;1696.787901512311;1701.174930158872;1701.7702610147596;62981.37018629847;66648;68289;69498.99999999949;71212.28787712108;8098.35213182944;8635.740927772176;8774.736757897273;8844.73465796027;8987.910120898707;11593;11682.299062056303;11691.298522088702;11692.29846209213;11693.473793679304;6265;6668.966655166791;6777.762778302835;6855.5543889647015;6891.620960847202;5983.970080149571;6098.69506524672;6209.379062093845;6212.627242365473;6241.188645476059;3614.6385361463645;3652.214773823641;3701.777893326409;3702.9259414811554;3764.1154328732728;1752.8685348598906;1784.1436110666953;1790.149678902511;1817.681905666503;1821.253286152671;368.46572469918726;372.6925286638534;794.9284564389233;800.8758642410436;829.0631586307554;10358.206440679569;10490.265681402228;10623.20325975555;10765.192610554239;11014.50434730439;395.2174694105687;396.81349765610116;404.834018052597;407.3685787030092;420.16177725437336;5544.63959842609;5614.522765564972;5719.8856022880145;5733.541316694655;5844.977129002407;381873;392384;393964;394551;395180;45018.09963800706;46238;58412.41587584155;61181;82577.58711206526;883.9337049721169;886.6453418632469;920.8848893888264;925.8842644669417;926.9119433653792;15683;15713.921430392775;16281.755773663168;16338;16631.584210394838;25937.740622593534;34928.65071349355;37087.6291237095;38727.80636096802;38913.610863891;47653;50167.74916125542;52802.471975279754;53825.73087134539;54909;7576.886346704914;7609.733659321897;7695.769126926201;7786.26030527099;7845.646945887563;9383.483908385104;11754.471048802654;11838.763224735285;12183.573574925189;12379.876201237872;10150.187984961038;10219.642312519027;10457.111145552713;10525.631602893862;10764;10163;10313.9484302581;10409;10561.841572376574;10767.461626918779;10018.699439016842;10179.236557258087;10257.948710256402;10500.789984200426;10836.187285953427;7470.738524151846;7508.324250817234;7522.849543009;7596.430267730053;7861.371090312876;8879.378443509151;10178.287519873835;10229.539670714687;10249.487525623837;10663 04:37:46 INFO - PROCESS | 12398 | |3;mootools.html;1291.3156027305527;1346.7979803029546;1359.653288411455;1576.50863667608;1650.4718490083171;6647.302033286495;6883.965580172105;7297.525660832049;7870.212978702134;7888.25061619146;7351.889721654179;7629.771106866789;7643;7838.529688218711;7867.567283799389;2105.52625659227;2127.8297736181066;2129.818965387944;2138.786121387864;2147.5812216617765;1756.919494510873;1815.1650240889207;2037.5822956293923;2141.389703934379;2165.750938642053;2065.1429656692453;2101.663733802592;2104.905279262437;2108.947276318089;2111.313823007521;2063.401613532074;2080.2615071649575;2088.091680119138;2100.369889033284;2103.064136459276;2031.441353627764;2058.8455865809974;2063.401613532074;2064.556120434099;2068.90689918954;7288.890666640004;7330.706771729125;7345.3021962913435;7686.654100565488;7760.805979850493;4352;4474.8881277967985;4476.440444944382;4478.641708663299;4483.30508771141;2735.7401046900513;2906.1862678450066;2949.7640188784844;2952.3652414730936;2955.113465960225;894.7181637784142;937.236152535688;941.7127776028309;946.5551190940247;952.7046615549202;9818.852717209247;10044.39733615978;10059.09468147863;10064.094231519126;10066.345687530287;3840.251151025523;3923.941140882889;4007.979960100181;4037.394390841397;4041.7672609854276;8766.693165739296;8768.25469835071;8770.473771573726;8778.253848422828;8781.692640757543;4413.536578659195;4426.690131690815;4439.467263928349;4440.134173836135;4440.666949978765;3853.402722578005;3912.9608703912595;4024.2353952748886;4056.8985775355854;4083.0813067060267;3355.865765369358;3390.5422767926507;3465.8440370183403;3472.409690352646;3473.7394695397948;1018.4195008845036;1068.5191663751189;1083.2796190533206;1109.8557187565725;1139.196866209337;765.345629486792;799.5762246009624;810.9391795615353;814.6537721468352;869.3827382558328;4981.651284410129;5026.447090820006;5213.843584692465;5228.92156617651;5477.507024367746;773.9148693643695;815.649270813544;852.7677506003889;876.9254613357808;912.1744820937063;3495.7378196635354;3598.136447252693;3610.3862343401684;3634.3821550336506;3723.255348930225;8483.490990540588;8842.646294148162;8978.10218978097;9162.267018638493;9235.307351948632;9115.36192466521;9116.179543841086;9124.726258212264;9125.041870603623;9130.223930965942;6803.387695107464;6840.828979275558;6871.4502839772695;6923.273056329113;7017.157941047107;5073.213651883964;5099.23511473282;5159.845204643867;5183.118869792069;5227.92158117621;8170.142135075732;8267.338612911073;8395.916040839758;8478.660853565789;8479.19447652472;8387.790305242417;8429.199226073513;8515.446495977742;8537.701180458655;8666.610002549774;6326;6433.710483028181;6435.163428754232;6437.130987316839;6438.034294855809;6884.139482564679;7037.225905150327;7071.82320441993;7082.752103676346;7087.929120708727;5734.111212762028;6017;6181.381861813962;6405.51958603116;6523.608583485006;6379.266384365857;6433.324500927335;6454.128692626436;6457.838554036187;6519.380658837403;6226.813195604139;6338.968305158444;6339.778107766206;6340.841478962879;6348.492120630431;4619.514950930238;4751.928721069117;4778.7849546769785;4841.370621819141;4860.927086093782;4609;4663.27719203524;4693.272542755878;4723.409573803275;4919.508049195052 04:37:46 INFO - PROCESS | 12398 | |4;prototype.html;285.469027608648;288.12266648056664;292.4239248680101;294.64053854297754;298.6863793017334;4616.19216637088;4775.689580177286;4790.562831150658;4833.37166168398;4834.395700537433;4525.547445255473;4647.674662773607;4666.300054991753;4678.573035224255;4713.245880659095;3737.738358314919;3739.88780336589;3744.794036328001;3746.4005759078623;3747.344214762419;3511.192425742081;3656.067702735799;3732.701383889296;3742.906427339311;3756.9436458453147;3624.6737793598572;3693.873368622569;3716.535433070866;3720.6465385788306;3730.1607138393915;3712.1647629283466;3725.4970578971897;3727.105494681284;3732.2722069196516;3732.88801335959;3316.2206881382854;3316.3201543683485;3317.8672853085845;3318.888172462228;3330.7668463207583;4545.522720114406;4584.977075114636;4609.423822022247;4633.536646335373;4654.767261636938;4261.827997300736;4264.637505812009;4271.380649805792;4272.081502476983;4278.694998025601;4950.628702847301;4969;4984.177610694231;5026.371703537058;5027.773750181214;3410.539577157077;3535.840887160084;3578.4453409721536;3594.19130695594;3608.368535506302;5091.159958606825;5102.770375333119;5107.846764597031;5113.53978141969;5135.152699804527;3646.58064322601;3649.379605467077;3650.6896913762625;3668.3763760160837;3684.9263014739554;3714.201446688921;3744.1466474095496;3748.175401411685;3750.3811871041516;3754.755940863835;3927.8232479538487;4122.443470131554;4140.834366625361;4148.709590328648;4250.638695710837;4886.633502487328;4907.484714104968;4908.374019899336;4911.263310503453;4920.4833492483485;1173.5657806611437;1201.2732296960214;1212.0969877441187;1242.5338101040677;1251.5181655062866;839.4375768235298;841.9789505262295;856.4304737349718;861.6553378648591;864.4208380385157;4389.714668546534;4389.934150987738;4394.516603173713;4401.273789824707;4414.955850441519;5033.149640525001;5053.519915608012;5055.090083784954;5057.443681195065;5071.518205770446;4376.927652725103;4385.254506733863;4391.165678521134;4398.472183337956;4399.12017596482;2298.770122987721;2402.0872068613817;2403.242978461779;2407.337982054949;2413.7327902851143;4352.825886964486;4359.237133501688;4364.9127017460105;4376.387305777193;4390.582894625006;4615.838445654386;4623.514530974267;4634.304854271819;4662.580367766849;4682.461516925598;4185.288500954845;4351.543087975717;4358.760268185153;4359.629431498358;4405.664997551303;4497;4524.936639889557;4527.84152554659;4543.182227199136;4557.453105627346;4401.962645774405;4408.9118217636105;4456.264716321771;4469.240229161115;4488.483824360241;4156;4242.2006233674865;4248.511421186603;4301.2472817257485;4317.309230523101;3137.215696075981;3176.698213669698;3229.4509933311865;3229.935401292008;3230.6930841570015;4481.484629267676;4507.459104907432;4531.41400509819;4535.591796738309;4548.772561371984;4760.8333708321425;4878.317035614946;4896.36347274852;4945.876353091202;4998.725070121032;4967.7516124192925;4990.126727822544;4993.377152425403;4994.275830004702;4997.375328083989;4895.412550493964;4913.312136300992;4917.181162460737;4935.506449355035;4936.506349365035;4758.286257061469;4962.900741985212;5029.471905450021;5036.974815125901;5048.495150485069;4921.557059864629;4927.926081108714;4933.186024305949;4943.777530011086;4956.306117143531 04:37:46 INFO - PROCESS | 12398 | |5;yui.html;582.478681579986;584.8187062010775;662.6487961380467;673.9991113196899;711.3988679565769;12086.879131208696;12739.235645861254;12767.29779862106;12774;12775.169613975097;12661.303628300462;12699.4920203192;12729.363531823417;12737.554185603505;12750.979921606273;604.6311749832598;617.3857012272772;716.0977168767339;718.8310746974457;737.5427235114237;744.0401881572792;746.4066067476342;746.723712226477;746.9066366704162;747.1631772414903;785.9135495095535;787.0712559180165;787.5668382389663;787.7991112266365;787.8384931089141;621.2110619513215;638.2723694987718;639.6609796807653;639.9232092148925;781.4256521456725;473.5217430395291;556.4129843015617;566.2044827018046;569.9116636921284;573.0086949577213;10455.738606534822;10522;10522.947385263025;10654.78690426195;10659.626913058006;12251.69370765729;12511.311877846714;12586.370681465982;12707.618771436872;13273.876699058203;8918.420302680304;9112.772180695469;10703.892961070445;10891.400972946485;10901.890981090168;4071.5521292657786;4085.3667681509414;4123.3196522573735;4190.979045104786;4294.935575966363;61957.07064394083;62411;63203.367966320206;63799;64455.35544644587;10096.091351778228;10121.696349109392;10164.440955747505;10252.333598316085;10345.534450949724;17530.211140498708;17554.473365799047;17561.56096097608;17608.55978600545;17656.55858603545;6763.222229443579;6951.27011663768;7041.683124259421;7044.7534336299;7162.7493037743425;3765.246950609889;3776.6412190841825;3798.7530810497783;3859.286032084073;3917.4515567820526;2822.731840475152;2937.4859399604984;2960.6891276416095;2965.466216081083;2967.940641187164;501.5836855410001;505.8254902058784;505.91146549353715;512.075703355447;545.3809925734241;491.15766460520376;548.7091841324104;561.1890817768367;577.933537643168;586.4633860018035;7570.659320330598;7713.614319284014;7739.110002349689;7847.568383738949;8035.477693949874;474.69382248449557;478.64580210643874;492.59361027152744;494.30303272385765;511.88482591416636;3613.5483064616924;3871.6515513603913;3909.765414075108;3953.347697629916;4081.3469844824685;102778;104524;106152.46923765332;108205.45897270463;109228.4538577302;54028.72985635047;67123.66438167778;80171.59914200509;86302.56848715716;87988.5600571993;61434.69282653558;63115.6844215776;79489;82250;84966;7418.666160022704;7690.192529784292;7852.803679908048;8180.263776260165;8633.784155396166;38057;38481;40889;42882;45255.54744452513;39194.412083819334;40046.59953400429;49113.01773964572;58619.70690146522;60904.39095608987;10854.510328429125;11077;11195.2723073;11342.092632589209;11350.091992640733;11907;12247.632571022883;13195.60413187606;13211.537596184087;13223.471061157446;11551.768964620493;11620.941895290807;11710.824337635113;11911.702207444536;12573.245605263714;10915.890841091805;11164.888351116384;11165.776684466427;11580.768384632092;11858.703532411413;10207.540660670436;10343.689689309333;10473.528691208761;10905;11067.280626759235;9424.623015079595;9633.662821801203;9868.309218354647;10009;10221.488925553544;9579.233661307218;10247.180225582084;10310.123639490428;10337;10344.32761870476 04:37:46 INFO - PROCESS | 12398 | __end_tp_report 04:37:46 INFO - PROCESS | 12398 | __start_cc_report 04:37:46 INFO - PROCESS | 12398 | _x_x_mozilla_cycle_collect,1156 04:37:46 INFO - PROCESS | 12398 | __end_cc_report 04:37:46 INFO - PROCESS | 12398 | __startTimestamp1474544266744__endTimestamp 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | ------- Summary: start ------- 04:37:46 INFO - PROCESS | 12398 | Number of tests: 6 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | [#0] dojo.html Cycles:165 Average:4560.08 Median:4698.11 stddev:480.44 (10.2%) stddev-sans-first:455.66 04:37:46 INFO - PROCESS | 12398 | Values: 2563.3 2589.9 2604.4 2616.9 2636.8 4428.9 4489.3 4641.7 4650.0 4658.1 4514.4 4598.7 4603.4 4610.1 4627.6 4182.8 4209.6 4242.6 4248.3 4321.1 4224.4 4284.9 4310.2 4313.2 4369.3 4091.2 4112.6 4120.0 4268.9 4282.2 4156.7 4173.5 4176.0 4179.2 4184.1 4149.5 4151.1 4153.1 4153.7 4157.7 4559.1 4674.0 4683.8 4738.9 4747.0 4972.5 4973.0 4983.7 4985.7 5048.4 5003.0 5005.7 5009.0 5016.6 5073.8 4492.6 4541.6 4543.7 4588.8 4628.3 5073.5 5090.8 5126.2 5132.0 5133.9 4851.8 4881.1 4889.0 4891.7 4951.4 4704.3 4946.6 4946.9 4952.3 5010.2 4726.7 4865.8 4882.2 4922.1 5002.9 4890.0 4900.3 4900.4 4904.9 4963.2 4243.7 4261.0 4266.0 4271.0 4317.8 3599.1 3629.1 3630.3 3657.8 3661.0 4254.2 4260.0 4306.4 4307.7 4308.6 4909.1 4920.6 4923.8 4938.2 4982.0 4138.3 4179.9 4198.6 4257.9 4257.9 4460.2 4494.3 4495.0 4530.9 4542.6 4687.9 4689.9 4698.1 4700.7 4738.0 4822.4 4850.5 4928.2 4929.0 4977.0 4644.5 4677.2 4690.6 4693.4 4729.6 4797.6 4816.1 4827.0 4843.2 4880.6 4750.5 4915.8 4926.8 4931.6 4985.9 4652.6 4762.2 4768.4 4787.7 4845.8 4781.7 4791.3 4791.8 4795.2 4850.1 4734.6 4740.5 4741.2 4744.8 4793.7 4647.4 4697.2 4808.6 4822.6 4828.2 4743.3 4746.2 4748.1 4793.1 4803.4 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | [#1] ext.html Cycles:180 Average:42711.21 Median:198769.82 stddev:75121.18 (37.8%) stddev-sans-first:75265.25 04:37:46 INFO - PROCESS | 12398 | Values: 561.0 571.9 572.0 574.9 576.3 28337.9 29084.9 31115.1 38514.6 39914.8 39053.8 39575.8 39671.6 39680.6 39705.2 7687.3 7842.3 7851.7 7854.1 7859.3 7691.3 7761.8 7765.3 7778.4 7779.5 7761.5 7808.0 7812.0 7813.9 7815.2 7726.1 7739.6 7760.7 7764.9 7767.5 7721.3 7772.3 7777.3 7778.2 7783.5 36272.6 36592.5 36649.5 36649.8 36702.3 2783.4 2905.8 2948.1 3090.8 3219.6 27281.3 27388.6 27957.0 28056.9 28621.6 3439.8 3505.0 3522.1 3538.3 3663.6 181833.0 182194.0 183034.0 183675.0 184049.0 50407.0 50460.7 50466.2 50805.5 50810.2 31374.6 32587.3 32589.2 34179.1 34252.5 13615.7 13685.8 13696.7 13700.2 13723.3 10076.6 10124.4 10199.7 10244.6 10343.3 17577.4 17586.6 17624.6 17632.4 17639.6 6501.3 6533.7 6654.2 6746.0 6790.4 751.8 800.9 834.1 870.4 907.9 26193.6 27515.6 27709.3 27932.6 28235.3 892.6 924.7 966.3 969.0 1018.0 14405.5 14611.5 14671.8 14992.9 15042.6 353922.0 361397.0 361717.0 361784.0 362295.0 47778.8 48235.0 48303.5 48368.8 48382.3 1066.5 1099.5 1104.6 1157.4 1177.0 27296.5 28067.9 28805.0 29077.3 29340.3 40590.2 41158.6 41271.4 41306.6 41322.0 283349.0 284055.0 286134.0 286318.0 286709.0 24246.2 24926.1 24931.5 24973.4 24977.9 37582.2 37681.2 38356.8 39173.2 42001.4 33012.5 35975.6 36322.5 36358.5 36553.8 36100.0 36142.6 36260.8 36367.6 36694.6 35119.5 35329.1 36119.8 36274.5 36494.8 31148.5 33548.0 33691.3 33763.0 34000.5 24174.3 25528.9 26735.7 27084.3 27345.3 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | [#2] jquery.html Cycles:180 Average:23225.07 Median:197473.11 stddev:64436.70 (32.6%) stddev-sans-first:64594.55 04:37:46 INFO - PROCESS | 12398 | Values: 337.6 351.1 352.4 359.5 385.4 12038.3 15299.5 16100.8 16143.5 17520.0 16829.1 16947.8 16957.5 17105.1 17170.1 4084.1 4932.9 5132.6 5134.3 5158.2 4928.3 5047.3 5050.1 5050.4 5054.7 4800.2 5010.2 5015.3 5020.5 5020.6 4975.7 4997.6 5015.1 5015.6 5017.7 4479.1 4480.1 4484.3 4485.5 4692.3 17976.0 18545.6 19276.7 19524.1 19528.0 1783.3 1855.3 1873.5 1929.4 1947.7 8382.6 9150.3 9328.2 11829.6 12463.9 1661.6 1683.4 1696.8 1701.2 1701.8 62981.4 66648.0 68289.0 69499.0 71212.3 8098.4 8635.7 8774.7 8844.7 8987.9 11593.0 11682.3 11691.3 11692.3 11693.5 6265.0 6669.0 6777.8 6855.6 6891.6 5984.0 6098.7 6209.4 6212.6 6241.2 3614.6 3652.2 3701.8 3702.9 3764.1 1752.9 1784.1 1790.1 1817.7 1821.3 368.5 372.7 794.9 800.9 829.1 10358.2 10490.3 10623.2 10765.2 11014.5 395.2 396.8 404.8 407.4 420.2 5544.6 5614.5 5719.9 5733.5 5845.0 381873.0 392384.0 393964.0 394551.0 395180.0 45018.1 46238.0 58412.4 61181.0 82577.6 883.9 886.6 920.9 925.9 926.9 15683.0 15713.9 16281.8 16338.0 16631.6 25937.7 34928.7 37087.6 38727.8 38913.6 47653.0 50167.7 52802.5 53825.7 54909.0 7576.9 7609.7 7695.8 7786.3 7845.6 9383.5 11754.5 11838.8 12183.6 12379.9 10150.2 10219.6 10457.1 10525.6 10764.0 10163.0 10313.9 10409.0 10561.8 10767.5 10018.7 10179.2 10257.9 10500.8 10836.2 7470.7 7508.3 7522.8 7596.4 7861.4 8879.4 10178.3 10229.5 10249.5 10663.0 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | [#3] mootools.html Cycles:180 Average:4931.83 Median:5220.88 stddev:2712.44 (52.0%) stddev-sans-first:2706.25 04:37:46 INFO - PROCESS | 12398 | Values: 1291.3 1346.8 1359.7 1576.5 1650.5 6647.3 6884.0 7297.5 7870.2 7888.3 7351.9 7629.8 7643.0 7838.5 7867.6 2105.5 2127.8 2129.8 2138.8 2147.6 1756.9 1815.2 2037.6 2141.4 2165.8 2065.1 2101.7 2104.9 2108.9 2111.3 2063.4 2080.3 2088.1 2100.4 2103.1 2031.4 2058.8 2063.4 2064.6 2068.9 7288.9 7330.7 7345.3 7686.7 7760.8 4352.0 4474.9 4476.4 4478.6 4483.3 2735.7 2906.2 2949.8 2952.4 2955.1 894.7 937.2 941.7 946.6 952.7 9818.9 10044.4 10059.1 10064.1 10066.3 3840.3 3923.9 4008.0 4037.4 4041.8 8766.7 8768.3 8770.5 8778.3 8781.7 4413.5 4426.7 4439.5 4440.1 4440.7 3853.4 3913.0 4024.2 4056.9 4083.1 3355.9 3390.5 3465.8 3472.4 3473.7 1018.4 1068.5 1083.3 1109.9 1139.2 765.3 799.6 810.9 814.7 869.4 4981.7 5026.4 5213.8 5228.9 5477.5 773.9 815.6 852.8 876.9 912.2 3495.7 3598.1 3610.4 3634.4 3723.3 8483.5 8842.6 8978.1 9162.3 9235.3 9115.4 9116.2 9124.7 9125.0 9130.2 6803.4 6840.8 6871.5 6923.3 7017.2 5073.2 5099.2 5159.8 5183.1 5227.9 8170.1 8267.3 8395.9 8478.7 8479.2 8387.8 8429.2 8515.4 8537.7 8666.6 6326.0 6433.7 6435.2 6437.1 6438.0 6884.1 7037.2 7071.8 7082.8 7087.9 5734.1 6017.0 6181.4 6405.5 6523.6 6379.3 6433.3 6454.1 6457.8 6519.4 6226.8 6339.0 6339.8 6340.8 6348.5 4619.5 4751.9 4778.8 4841.4 4860.9 4609.0 4663.3 4693.3 4723.4 4919.5 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | [#4] prototype.html Cycles:180 Average:4003.42 Median:4398.80 stddev:1154.90 (26.3%) stddev-sans-first:1123.92 04:37:46 INFO - PROCESS | 12398 | Values: 285.5 288.1 292.4 294.6 298.7 4616.2 4775.7 4790.6 4833.4 4834.4 4525.5 4647.7 4666.3 4678.6 4713.2 3737.7 3739.9 3744.8 3746.4 3747.3 3511.2 3656.1 3732.7 3742.9 3756.9 3624.7 3693.9 3716.5 3720.6 3730.2 3712.2 3725.5 3727.1 3732.3 3732.9 3316.2 3316.3 3317.9 3318.9 3330.8 4545.5 4585.0 4609.4 4633.5 4654.8 4261.8 4264.6 4271.4 4272.1 4278.7 4950.6 4969.0 4984.2 5026.4 5027.8 3410.5 3535.8 3578.4 3594.2 3608.4 5091.2 5102.8 5107.8 5113.5 5135.2 3646.6 3649.4 3650.7 3668.4 3684.9 3714.2 3744.1 3748.2 3750.4 3754.8 3927.8 4122.4 4140.8 4148.7 4250.6 4886.6 4907.5 4908.4 4911.3 4920.5 1173.6 1201.3 1212.1 1242.5 1251.5 839.4 842.0 856.4 861.7 864.4 4389.7 4389.9 4394.5 4401.3 4415.0 5033.1 5053.5 5055.1 5057.4 5071.5 4376.9 4385.3 4391.2 4398.5 4399.1 2298.8 2402.1 2403.2 2407.3 2413.7 4352.8 4359.2 4364.9 4376.4 4390.6 4615.8 4623.5 4634.3 4662.6 4682.5 4185.3 4351.5 4358.8 4359.6 4405.7 4497.0 4524.9 4527.8 4543.2 4557.5 4402.0 4408.9 4456.3 4469.2 4488.5 4156.0 4242.2 4248.5 4301.2 4317.3 3137.2 3176.7 3229.5 3229.9 3230.7 4481.5 4507.5 4531.4 4535.6 4548.8 4760.8 4878.3 4896.4 4945.9 4998.7 4967.8 4990.1 4993.4 4994.3 4997.4 4895.4 4913.3 4917.2 4935.5 4936.5 4758.3 4962.9 5029.5 5037.0 5048.5 4921.6 4927.9 4933.2 4943.8 4956.3 04:37:46 INFO - PROCESS | 12398 | 04:37:46 INFO - PROCESS | 12398 | [#5] yui.html Cycles:180 Average:17131.58 Median:22506.16 stddev:25110.68 (111.6%) stddev-sans-first:25150.38 04:37:46 INFO - PROCESS | 12398 | Values: 582.5 584.8 662.6 674.0 711.4 12086.9 12739.2 12767.3 12774.0 12775.2 12661.3 12699.5 12729.4 12737.6 12751.0 604.6 617.4 716.1 718.8 737.5 744.0 746.4 746.7 746.9 747.2 785.9 787.1 787.6 787.8 787.8 621.2 638.3 639.7 639.9 781.4 473.5 556.4 566.2 569.9 573.0 10455.7 10522.0 10522.9 10654.8 10659.6 12251.7 12511.3 12586.4 12707.6 13273.9 8918.4 9112.8 10703.9 10891.4 10901.9 4071.6 4085.4 4123.3 4191.0 4294.9 61957.1 62411.0 63203.4 63799.0 64455.4 10096.1 10121.7 10164.4 10252.3 10345.5 17530.2 17554.5 17561.6 17608.6 17656.6 6763.2 6951.3 7041.7 7044.8 7162.7 3765.2 3776.6 3798.8 3859.3 3917.5 2822.7 2937.5 2960.7 2965.5 2967.9 501.6 505.8 505.9 512.1 545.4 491.2 548.7 561.2 577.9 586.5 7570.7 7713.6 7739.1 7847.6 8035.5 474.7 478.6 492.6 494.3 511.9 3613.5 3871.7 3909.8 3953.3 4081.3 102778.0 104524.0 106152.5 108205.5 109228.5 54028.7 67123.7 80171.6 86302.6 87988.6 61434.7 63115.7 79489.0 82250.0 84966.0 7418.7 7690.2 7852.8 8180.3 8633.8 38057.0 38481.0 40889.0 42882.0 45255.5 39194.4 40046.6 49113.0 58619.7 60904.4 10854.5 11077.0 11195.3 11342.1 11350.1 11907.0 12247.6 13195.6 13211.5 13223.5 11551.8 11620.9 11710.8 11911.7 12573.2 10915.9 11164.9 11165.8 11580.8 11858.7 10207.5 10343.7 10473.5 10905.0 11067.3 9424.6 9633.7 9868.3 10009.0 10221.5 9579.2 10247.2 10310.1 10337.0 10344.3 04:37:46 INFO - PROCESS | 12398 | -------- Summary: end -------- 04:37:46 INFO - PROCESS | 12398 | 04:37:47 INFO - TEST-INFO | 12398: exit 0 04:37:47 INFO - TEST-OK | dromaeo_css | took 1121439ms 04:37:47 INFO - TEST-START | kraken 04:37:47 INFO - operating with platform_type : linux_ 04:37:47 INFO - Initialising browser for kraken test... 04:37:47 INFO - TEST-INFO | started process 12702 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp9GuOgr/profile http://localhost:34384/getInfo.html) 04:37:52 INFO - PROCESS | 12702 | __metrics Screen width/height:1600/1200 04:37:52 INFO - PROCESS | 12702 | colorDepth:24 04:37:52 INFO - PROCESS | 12702 | Browser inner width/height: 1024/697 04:37:52 INFO - PROCESS | 12702 | __metrics 04:37:52 INFO - PROCESS | 12702 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:37:52 INFO - PROCESS | 12702 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:37:53 INFO - PROCESS | 12702 | console.error: PushService: 04:37:53 INFO - PROCESS | 12702 | stateChangeProcessEnqueue: Error transitioning state 04:37:53 INFO - PROCESS | 12702 | UnknownError 04:37:54 INFO - TEST-INFO | 12702: exit 0 04:37:54 INFO - Browser initialized. 04:37:54 INFO - Running cycle 1/1 for kraken test... 04:37:54 INFO - TEST-INFO | started process 12783 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp9GuOgr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:38:06 INFO - PROCESS | 12783 | RSS: Main: 175247360 04:38:06 INFO - PROCESS | 12783 | 04:38:09 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:34384/tests/kraken/driver.html?testName=audio-beat-detection) 04:38:10 INFO - PROCESS | 12783 | RSS: Main: 233824256 04:38:10 INFO - PROCESS | 12783 | 04:38:13 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:34384/tests/kraken/driver.html?testName=audio-dft) 04:38:13 INFO - PROCESS | 12783 | RSS: Main: 218349568 04:38:13 INFO - PROCESS | 12783 | 04:38:16 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:34384/tests/kraken/driver.html?testName=audio-fft) 04:38:17 INFO - PROCESS | 12783 | RSS: Main: 300359680 04:38:17 INFO - PROCESS | 12783 | 04:38:19 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:34384/tests/kraken/driver.html?testName=audio-oscillator) 04:38:20 INFO - PROCESS | 12783 | RSS: Main: 210464768 04:38:20 INFO - PROCESS | 12783 | 04:38:22 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:34384/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:38:23 INFO - PROCESS | 12783 | RSS: Main: 214016000 04:38:23 INFO - PROCESS | 12783 | 04:38:26 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:34384/tests/kraken/driver.html?testName=imaging-darkroom) 04:38:26 INFO - PROCESS | 12783 | RSS: Main: 250531840 04:38:26 INFO - PROCESS | 12783 | 04:38:30 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:34384/tests/kraken/driver.html?testName=imaging-desaturate) 04:38:31 INFO - PROCESS | 12783 | RSS: Main: 244154368 04:38:31 INFO - PROCESS | 12783 | 04:38:33 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:34384/tests/kraken/driver.html?testName=json-parse-financial) 04:38:34 INFO - PROCESS | 12783 | RSS: Main: 247238656 04:38:34 INFO - PROCESS | 12783 | 04:38:36 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:34384/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:38:36 INFO - PROCESS | 12783 | RSS: Main: 210624512 04:38:36 INFO - PROCESS | 12783 | 04:38:38 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:38:39 INFO - PROCESS | 12783 | RSS: Main: 217432064 04:38:39 INFO - PROCESS | 12783 | 04:38:41 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:38:42 INFO - PROCESS | 12783 | RSS: Main: 222740480 04:38:42 INFO - PROCESS | 12783 | 04:38:45 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:38:45 INFO - PROCESS | 12783 | RSS: Main: 223461376 04:38:45 INFO - PROCESS | 12783 | 04:38:48 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:38:49 INFO - PROCESS | 12783 | RSS: Main: 221929472 04:38:49 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | Cycle 1(1): loaded http://localhost:34384/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:34384/tests/kraken/driver.html?testName=ai-astar) 04:38:51 INFO - PROCESS | 12783 | RSS: Main: 272588800 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | __start_tp_report 04:38:51 INFO - PROCESS | 12783 | _x_x_mozilla_page_load 04:38:51 INFO - PROCESS | 12783 | _x_x_mozilla_page_load_details 04:38:51 INFO - PROCESS | 12783 | |i|pagename|runs| 04:38:51 INFO - PROCESS | 12783 | |0;ai-astar;113;118;114;116;115;117;116;115;115;116 04:38:51 INFO - PROCESS | 12783 | |1;audio-beat-detection;158;130;131;160;123;129;122;123;151;127 04:38:51 INFO - PROCESS | 12783 | |2;audio-dft;161;160;161;161;161;160;161;161;162;161 04:38:51 INFO - PROCESS | 12783 | |3;audio-fft;76;76;75;108;77;79;77;77;108;78 04:38:51 INFO - PROCESS | 12783 | |4;audio-oscillator;84;85;136;85;84;84;104;85;84;129 04:38:51 INFO - PROCESS | 12783 | |5;imaging-gaussian-blur;117;117;116;116;117;116;117;117;117;117 04:38:51 INFO - PROCESS | 12783 | |6;imaging-darkroom;146;146;148;147;147;147;147;147;146;147 04:38:51 INFO - PROCESS | 12783 | |7;imaging-desaturate;96;95;95;95;94;95;95;94;95;94 04:38:51 INFO - PROCESS | 12783 | |8;json-parse-financial;64;62;63;63;65;65;65;66;64;64 04:38:51 INFO - PROCESS | 12783 | |9;json-stringify-tinderbox;66;67;67;67;66;66;66;66;66;67 04:38:51 INFO - PROCESS | 12783 | |10;stanford-crypto-aes;92;86;83;83;84;83;84;84;82;82 04:38:51 INFO - PROCESS | 12783 | |11;stanford-crypto-ccm;139;156;152;134;142;143;135;132;174;131 04:38:51 INFO - PROCESS | 12783 | |12;stanford-crypto-pbkdf2;180;176;173;176;174;173;172;174;176;171 04:38:51 INFO - PROCESS | 12783 | |13;stanford-crypto-sha256-iterative;70;69;70;70;70;69;70;68;70;68 04:38:51 INFO - PROCESS | 12783 | __end_tp_report 04:38:51 INFO - PROCESS | 12783 | __start_cc_report 04:38:51 INFO - PROCESS | 12783 | _x_x_mozilla_cycle_collect,1966 04:38:51 INFO - PROCESS | 12783 | __end_cc_report 04:38:51 INFO - PROCESS | 12783 | __startTimestamp1474544331427__endTimestamp 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | ------- Summary: start ------- 04:38:51 INFO - PROCESS | 12783 | Number of tests: 14 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#0] ai-astar Cycles:10 Average:115.50 Median:116.00 stddev:1.43 (1.2%) stddev-sans-first:1.20 04:38:51 INFO - PROCESS | 12783 | Values: 113.0 118.0 114.0 116.0 115.0 117.0 116.0 115.0 115.0 116.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#1] audio-beat-detection Cycles:10 Average:135.40 Median:130.50 stddev:14.93 (11.4%) stddev-sans-first:13.41 04:38:51 INFO - PROCESS | 12783 | Values: 158.0 130.0 131.0 160.0 123.0 129.0 122.0 123.0 151.0 127.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#2] audio-dft Cycles:10 Average:160.90 Median:161.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 04:38:51 INFO - PROCESS | 12783 | Values: 161.0 160.0 161.0 161.0 161.0 160.0 161.0 161.0 162.0 161.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#3] audio-fft Cycles:10 Average:83.10 Median:77.00 stddev:13.17 (17.1%) stddev-sans-first:13.72 04:38:51 INFO - PROCESS | 12783 | Values: 76.0 76.0 75.0 108.0 77.0 79.0 77.0 77.0 108.0 78.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#4] audio-oscillator Cycles:10 Average:96.00 Median:84.00 stddev:20.25 (24.1%) stddev-sans-first:21.01 04:38:51 INFO - PROCESS | 12783 | Values: 84.0 85.0 136.0 85.0 84.0 84.0 104.0 85.0 84.0 129.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 04:38:51 INFO - PROCESS | 12783 | Values: 117.0 117.0 116.0 116.0 117.0 116.0 117.0 117.0 117.0 117.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.63 (0.4%) stddev-sans-first:0.60 04:38:51 INFO - PROCESS | 12783 | Values: 146.0 146.0 148.0 147.0 147.0 147.0 147.0 147.0 146.0 147.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#7] imaging-desaturate Cycles:10 Average:94.80 Median:95.00 stddev:0.63 (0.7%) stddev-sans-first:0.50 04:38:51 INFO - PROCESS | 12783 | Values: 96.0 95.0 95.0 95.0 94.0 95.0 95.0 94.0 95.0 94.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#8] json-parse-financial Cycles:10 Average:64.10 Median:64.50 stddev:1.20 (1.9%) stddev-sans-first:1.27 04:38:51 INFO - PROCESS | 12783 | Values: 64.0 62.0 63.0 63.0 65.0 65.0 65.0 66.0 64.0 64.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#9] json-stringify-tinderbox Cycles:10 Average:66.40 Median:66.50 stddev:0.52 (0.8%) stddev-sans-first:0.53 04:38:51 INFO - PROCESS | 12783 | Values: 66.0 67.0 67.0 67.0 66.0 66.0 66.0 66.0 66.0 67.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#10] stanford-crypto-aes Cycles:10 Average:84.30 Median:84.00 stddev:2.95 (3.5%) stddev-sans-first:1.24 04:38:51 INFO - PROCESS | 12783 | Values: 92.0 86.0 83.0 83.0 84.0 83.0 84.0 84.0 82.0 82.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#11] stanford-crypto-ccm Cycles:10 Average:143.80 Median:142.50 stddev:13.46 (9.4%) stddev-sans-first:14.17 04:38:51 INFO - PROCESS | 12783 | Values: 139.0 156.0 152.0 134.0 142.0 143.0 135.0 132.0 174.0 131.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:174.50 Median:175.00 stddev:2.59 (1.5%) stddev-sans-first:1.83 04:38:51 INFO - PROCESS | 12783 | Values: 180.0 176.0 173.0 176.0 174.0 173.0 172.0 174.0 176.0 171.0 04:38:51 INFO - PROCESS | 12783 | 04:38:51 INFO - PROCESS | 12783 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.40 Median:70.00 stddev:0.84 (1.2%) stddev-sans-first:0.87 04:38:51 INFO - PROCESS | 12783 | Values: 70.0 69.0 70.0 70.0 70.0 69.0 70.0 68.0 70.0 68.0 04:38:51 INFO - PROCESS | 12783 | -------- Summary: end -------- 04:38:51 INFO - PROCESS | 12783 | 04:38:52 INFO - TEST-INFO | 12783: exit 0 04:38:52 INFO - TEST-OK | kraken | took 64953ms 04:38:52 INFO - SUITE-END | took 1186s 04:38:53 INFO - Completed test suite (00:19:46) 04:38:53 INFO - javascript benchmark 04:38:53 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2563.320720009198, 2589.9352516187105, 2604.361931326825, 2616.8691565421736, 2636.78905687545, 4428.911421771562, 4489.2817149256125, 4641.651876109293, 4650.0467404182145, 4658.091672123933, 4514.390557274775, 4598.70108442951, 4603.424571928509, 4610.0549387375595, 4627.583517483426, 4182.769947652878, 4209.621134097931, 4242.618164365206, 4248.341507066394, 4321.092570560186, 4224.366345048236, 4284.850030248942, 4310.181065597542, 4313.180495705821, 4369.3227549729845, 4091.2431200227757, 4112.588741125894, 4119.97940010301, 4268.935965960513, 4282.164977829325, 4156.709030367875, 4173.52004519478, 4176.0, 4179.2059508693255, 4184.14225083857, 4149.522804877448, 4151.107511884929, 4153.086321009373, 4153.7300075494995, 4157.729747566398, 4559.110973360196, 4674.041821426634, 4683.765811709435, 4738.905221895578, 4747.0, 4972.5276098770555, 4973.0, 4983.676061056056, 4985.700857948535, 5048.368953880765, 5002.99940011999, 5005.74971251436, 5009.023240468074, 5016.573591244749, 5073.822416215452, 4492.573205545468, 4541.613962813165, 4543.727376357429, 4588.7935042923145, 4628.305754136906, 5073.492650734971, 5090.796368145307, 5126.231065340229, 5132.0, 5133.922991155136, 4851.781669824866, 4881.121398148296, 4888.9755551222015, 4891.706497610155, 4951.405831300195, 4704.294355846582, 4946.579540739078, 4946.901061978812, 4952.257161425815, 5010.223415370623, 4726.740029298421, 4865.829695960624, 4882.2432522959, 4922.064807686528, 5002.924956125661, 4889.951100489021, 4900.289458028566, 4900.362952816111, 4904.8773780655765, 4963.156263435225, 4243.6605071594195, 4261.041265715189, 4266.040140968257, 4271.0, 4317.762523061262, 3599.136207310227, 3629.1471504196493, 3630.2739452109686, 3657.798821064867, 3661.0, 4254.170436764801, 4259.957400425956, 4306.418633484503, 4307.655387568987, 4308.590683885026, 4909.091818013679, 4920.5571498565305, 4923.761118170264, 4938.160512712776, 4981.975090124599, 4138.275801734684, 4179.91640167195, 4198.6431153352305, 4257.850975215914, 4257.893552661209, 4460.1525710114975, 4494.280915053576, 4494.977525112419, 4530.932036019462, 4542.591166795004, 4687.906241875212, 4689.859304220879, 4698.107359601733, 4700.741459219776, 4737.952620473751, 4822.373091498082, 4850.46644869057, 4928.186849169991, 4928.950710492993, 4977.0, 4644.535546445329, 4677.228257337501, 4690.624750020059, 4693.436787585511, 4729.645276604338, 4797.56821886032, 4816.133096042746, 4827.0, 4843.200871856105, 4880.560749532559, 4750.453697824794, 4915.754212289443, 4926.778294976663, 4931.605471562195, 4985.925211121908, 4652.627789776742, 4762.214234651244, 4768.427788665383, 4787.736674482937, 4845.781939812788, 4781.6891902026255, 4791.305260737104, 4791.808327666854, 4795.20879054952, 4850.1269771441475, 4734.621230301636, 4740.478547359857, 4741.193997020446, 4744.78648460827, 4793.664443488922, 4647.395838540968, 4697.201475749062, 4808.591269742111, 4822.590079843112, 4828.179209534317, 4743.312219728189, 4746.216874215854, 4748.145333839942, 4793.113274044313, 4803.447603525639], "value": 4529.556233884018, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [561.0406205388784, 571.8827640333732, 572.0275531596286, 574.870654102827, 576.3026737647447, 28337.858310708445, 29084.854575727117, 31115.066548003568, 38514.61485385145, 39914.8004259979, 39053.80473097638, 39575.80212098943, 39671.603283967226, 39680.603193968054, 39705.20589588206, 7687.2697093776005, 7842.294193522582, 7851.685932562691, 7854.136045035041, 7859.29266366027, 7691.307782299592, 7761.796921477152, 7765.301122898938, 7778.377729781604, 7779.494332868374, 7761.534307941513, 7808.0, 7812.0, 7813.882791758099, 7815.179406162356, 7726.111497177841, 7739.57432341221, 7760.689572417096, 7764.922350776476, 7767.456278060538, 7721.266479684421, 7772.3393511551585, 7777.261160189773, 7778.222177782233, 7783.494072885301, 36272.63727362746, 36592.45111323332, 36649.45025824615, 36649.81675091634, 36702.265954681025, 2783.3876547159593, 2905.7675385969073, 2948.0713575223735, 3090.7681923855803, 3219.6297425795865, 27281.289711708647, 27388.58917116245, 27957.0, 28056.859715701496, 28621.57067643987, 3439.7592168548213, 3505.0361150683766, 3522.084258092889, 3538.274653695986, 3663.5603727552866, 181833.0, 182194.0, 183034.0, 183674.99999999866, 184049.0, 50407.0, 50460.74769626202, 50466.24300635493, 50805.491945080816, 50810.237846432334, 31374.64690148248, 32587.34825303481, 32589.185270367958, 34179.14552136217, 34252.486212706826, 13615.727685446236, 13685.79471307931, 13696.65758356049, 13700.177989320673, 13723.313834308445, 10076.59693612262, 10124.443155626512, 10199.7450063749, 10244.641437549799, 10343.327683700536, 17577.42986823435, 17586.648267034587, 17624.559386015197, 17632.382866599863, 17639.559011024572, 6501.349865013461, 6533.673316334164, 6654.201495820533, 6745.9662701686175, 6790.388865002074, 751.8045308219902, 800.917614203079, 834.1200033964104, 870.4342177584621, 907.945523268606, 26193.607095893578, 27515.58726619102, 27709.30726731848, 27932.58101128485, 28235.294117647223, 892.5715656484793, 924.7040946897063, 966.3477152921749, 968.9951550242345, 1018.0176130034553, 14405.495807646892, 14611.488597899022, 14671.77992330116, 14992.925035374754, 15042.646161845487, 353922.0, 361397.0, 361717.0, 361784.0, 362295.0, 47778.761106194244, 48235.0, 48303.516964829905, 48368.75815620899, 48382.27426588604, 1066.5413872034944, 1099.4612639806437, 1104.6133853151332, 1157.3576664951033, 1176.9588064417703, 27296.454070918866, 28067.859660701564, 28805.0, 29077.273068173465, 29340.266493337836, 40590.18819623532, 41158.588414115475, 41271.380929286686, 41306.586934130275, 41322.0, 283349.0, 284055.0, 286134.0, 286318.0, 286709.0, 24246.15138470145, 24926.127585534417, 24931.501369972862, 24973.375665608506, 24977.875110625057, 37582.24835503329, 37681.24637507289, 38356.80821595874, 39173.21653566856, 42001.369979450945, 33012.50481242735, 35975.64024359723, 36322.4551631731, 36358.45490815618, 36553.81723091474, 36100.0, 36142.63857361393, 36260.81869590635, 36367.63632363643, 36694.633053670186, 35119.47320790241, 35329.1167720809, 36119.81940090283, 36274.4558831623, 36494.81752591326, 31148.532772007984, 33548.0, 33691.3261734759, 33763.0, 34000.489992650626, 24174.274771756875, 25528.872355638105, 26735.732642674102, 27084.32289192786, 27345.31636709098], "value": 16657.539313829493, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [337.59151426773604, 351.13095089653126, 352.39388252206203, 359.450041436602, 385.387234297467, 12038.277703337795, 15299.54101376959, 16100.75848862268, 16143.515694529153, 17520.0, 16829.074400907946, 16947.83052169481, 16957.49127526176, 17105.0592217428, 17170.055646939414, 4084.0810817565957, 4932.926006109902, 5132.589392848582, 5134.306868572751, 5158.2004789257535, 4928.334674818907, 5047.343845300106, 5050.141475949097, 5050.444451110375, 5054.69671819692, 4800.207965685658, 5010.248462730583, 5015.272785446108, 5020.548150666439, 5020.573251273646, 4975.7263350515705, 4997.62517811162, 5015.072211640858, 5015.623828212899, 5017.724025178613, 4479.126570318789, 4480.126375356806, 4484.349769283468, 4485.484169320504, 4692.296155576657, 17976.0, 18545.62908741831, 19276.710849337273, 19524.12141453638, 19528.0, 1783.3134243316288, 1855.3320804510365, 1873.475426880462, 1929.411529483507, 1947.6883698608297, 8382.580870956428, 9150.267978561698, 9328.207102396305, 11829.645110646694, 12463.875361246362, 1661.5762980440031, 1683.4360489236121, 1696.787901512311, 1701.174930158872, 1701.7702610147596, 62981.37018629847, 66648.0, 68289.0, 69498.99999999949, 71212.28787712108, 8098.35213182944, 8635.740927772176, 8774.736757897273, 8844.73465796027, 8987.910120898707, 11593.0, 11682.299062056303, 11691.298522088702, 11692.29846209213, 11693.473793679304, 6265.0, 6668.966655166791, 6777.762778302835, 6855.5543889647015, 6891.620960847202, 5983.970080149571, 6098.69506524672, 6209.379062093845, 6212.627242365473, 6241.188645476059, 3614.6385361463645, 3652.214773823641, 3701.777893326409, 3702.9259414811554, 3764.1154328732728, 1752.8685348598906, 1784.1436110666953, 1790.149678902511, 1817.681905666503, 1821.253286152671, 368.46572469918726, 372.6925286638534, 794.9284564389233, 800.8758642410436, 829.0631586307554, 10358.206440679569, 10490.265681402228, 10623.20325975555, 10765.192610554239, 11014.50434730439, 395.2174694105687, 396.81349765610116, 404.834018052597, 407.3685787030092, 420.16177725437336, 5544.63959842609, 5614.522765564972, 5719.8856022880145, 5733.541316694655, 5844.977129002407, 381873.0, 392384.0, 393964.0, 394551.0, 395180.0, 45018.09963800706, 46238.0, 58412.41587584155, 61181.0, 82577.58711206526, 883.9337049721169, 886.6453418632469, 920.8848893888264, 925.8842644669417, 926.9119433653792, 15683.0, 15713.921430392775, 16281.755773663168, 16338.0, 16631.584210394838, 25937.740622593534, 34928.65071349355, 37087.6291237095, 38727.80636096802, 38913.610863891, 47653.0, 50167.74916125542, 52802.471975279754, 53825.73087134539, 54909.0, 7576.886346704914, 7609.733659321897, 7695.769126926201, 7786.26030527099, 7845.646945887563, 9383.483908385104, 11754.471048802654, 11838.763224735285, 12183.573574925189, 12379.876201237872, 10150.187984961038, 10219.642312519027, 10457.111145552713, 10525.631602893862, 10764.0, 10163.0, 10313.9484302581, 10409.0, 10561.841572376574, 10767.461626918779, 10018.699439016842, 10179.236557258087, 10257.948710256402, 10500.789984200426, 10836.187285953427, 7470.738524151846, 7508.324250817234, 7522.849543009, 7596.430267730053, 7861.371090312876, 8879.378443509151, 10178.287519873835, 10229.539670714687, 10249.487525623837, 10663.0], "value": 7421.606785852317, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1291.3156027305527, 1346.7979803029546, 1359.653288411455, 1576.50863667608, 1650.4718490083171, 6647.302033286495, 6883.965580172105, 7297.525660832049, 7870.212978702134, 7888.25061619146, 7351.889721654179, 7629.771106866789, 7643.0, 7838.529688218711, 7867.567283799389, 2105.52625659227, 2127.8297736181066, 2129.818965387944, 2138.786121387864, 2147.5812216617765, 1756.919494510873, 1815.1650240889207, 2037.5822956293923, 2141.389703934379, 2165.750938642053, 2065.1429656692453, 2101.663733802592, 2104.905279262437, 2108.947276318089, 2111.313823007521, 2063.401613532074, 2080.2615071649575, 2088.091680119138, 2100.369889033284, 2103.064136459276, 2031.441353627764, 2058.8455865809974, 2063.401613532074, 2064.556120434099, 2068.90689918954, 7288.890666640004, 7330.706771729125, 7345.3021962913435, 7686.654100565488, 7760.805979850493, 4352.0, 4474.8881277967985, 4476.440444944382, 4478.641708663299, 4483.30508771141, 2735.7401046900513, 2906.1862678450066, 2949.7640188784844, 2952.3652414730936, 2955.113465960225, 894.7181637784142, 937.236152535688, 941.7127776028309, 946.5551190940247, 952.7046615549202, 9818.852717209247, 10044.39733615978, 10059.09468147863, 10064.094231519126, 10066.345687530287, 3840.251151025523, 3923.941140882889, 4007.979960100181, 4037.394390841397, 4041.7672609854276, 8766.693165739296, 8768.25469835071, 8770.473771573726, 8778.253848422828, 8781.692640757543, 4413.536578659195, 4426.690131690815, 4439.467263928349, 4440.134173836135, 4440.666949978765, 3853.402722578005, 3912.9608703912595, 4024.2353952748886, 4056.8985775355854, 4083.0813067060267, 3355.865765369358, 3390.5422767926507, 3465.8440370183403, 3472.409690352646, 3473.7394695397948, 1018.4195008845036, 1068.5191663751189, 1083.2796190533206, 1109.8557187565725, 1139.196866209337, 765.345629486792, 799.5762246009624, 810.9391795615353, 814.6537721468352, 869.3827382558328, 4981.651284410129, 5026.447090820006, 5213.843584692465, 5228.92156617651, 5477.507024367746, 773.9148693643695, 815.649270813544, 852.7677506003889, 876.9254613357808, 912.1744820937063, 3495.7378196635354, 3598.136447252693, 3610.3862343401684, 3634.3821550336506, 3723.255348930225, 8483.490990540588, 8842.646294148162, 8978.10218978097, 9162.267018638493, 9235.307351948632, 9115.36192466521, 9116.179543841086, 9124.726258212264, 9125.041870603623, 9130.223930965942, 6803.387695107464, 6840.828979275558, 6871.4502839772695, 6923.273056329113, 7017.157941047107, 5073.213651883964, 5099.23511473282, 5159.845204643867, 5183.118869792069, 5227.92158117621, 8170.142135075732, 8267.338612911073, 8395.916040839758, 8478.660853565789, 8479.19447652472, 8387.790305242417, 8429.199226073513, 8515.446495977742, 8537.701180458655, 8666.610002549774, 6326.0, 6433.710483028181, 6435.163428754232, 6437.130987316839, 6438.034294855809, 6884.139482564679, 7037.225905150327, 7071.82320441993, 7082.752103676346, 7087.929120708727, 5734.111212762028, 6017.0, 6181.381861813962, 6405.51958603116, 6523.608583485006, 6379.266384365857, 6433.324500927335, 6454.128692626436, 6457.838554036187, 6519.380658837403, 6226.813195604139, 6338.968305158444, 6339.778107766206, 6340.841478962879, 6348.492120630431, 4619.514950930238, 4751.928721069117, 4778.7849546769785, 4841.370621819141, 4860.927086093782, 4609.0, 4663.27719203524, 4693.272542755878, 4723.409573803275, 4919.508049195052], "value": 3990.4892307689615, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [285.469027608648, 288.12266648056664, 292.4239248680101, 294.64053854297754, 298.6863793017334, 4616.19216637088, 4775.689580177286, 4790.562831150658, 4833.37166168398, 4834.395700537433, 4525.547445255473, 4647.674662773607, 4666.300054991753, 4678.573035224255, 4713.245880659095, 3737.738358314919, 3739.88780336589, 3744.794036328001, 3746.4005759078623, 3747.344214762419, 3511.192425742081, 3656.067702735799, 3732.701383889296, 3742.906427339311, 3756.9436458453147, 3624.6737793598572, 3693.873368622569, 3716.535433070866, 3720.6465385788306, 3730.1607138393915, 3712.1647629283466, 3725.4970578971897, 3727.105494681284, 3732.2722069196516, 3732.88801335959, 3316.2206881382854, 3316.3201543683485, 3317.8672853085845, 3318.888172462228, 3330.7668463207583, 4545.522720114406, 4584.977075114636, 4609.423822022247, 4633.536646335373, 4654.767261636938, 4261.827997300736, 4264.637505812009, 4271.380649805792, 4272.081502476983, 4278.694998025601, 4950.628702847301, 4969.0, 4984.177610694231, 5026.371703537058, 5027.773750181214, 3410.539577157077, 3535.840887160084, 3578.4453409721536, 3594.19130695594, 3608.368535506302, 5091.159958606825, 5102.770375333119, 5107.846764597031, 5113.53978141969, 5135.152699804527, 3646.58064322601, 3649.379605467077, 3650.6896913762625, 3668.3763760160837, 3684.9263014739554, 3714.201446688921, 3744.1466474095496, 3748.175401411685, 3750.3811871041516, 3754.755940863835, 3927.8232479538487, 4122.443470131554, 4140.834366625361, 4148.709590328648, 4250.638695710837, 4886.633502487328, 4907.484714104968, 4908.374019899336, 4911.263310503453, 4920.4833492483485, 1173.5657806611437, 1201.2732296960214, 1212.0969877441187, 1242.5338101040677, 1251.5181655062866, 839.4375768235298, 841.9789505262295, 856.4304737349718, 861.6553378648591, 864.4208380385157, 4389.714668546534, 4389.934150987738, 4394.516603173713, 4401.273789824707, 4414.955850441519, 5033.149640525001, 5053.519915608012, 5055.090083784954, 5057.443681195065, 5071.518205770446, 4376.927652725103, 4385.254506733863, 4391.165678521134, 4398.472183337956, 4399.12017596482, 2298.770122987721, 2402.0872068613817, 2403.242978461779, 2407.337982054949, 2413.7327902851143, 4352.825886964486, 4359.237133501688, 4364.9127017460105, 4376.387305777193, 4390.582894625006, 4615.838445654386, 4623.514530974267, 4634.304854271819, 4662.580367766849, 4682.461516925598, 4185.288500954845, 4351.543087975717, 4358.760268185153, 4359.629431498358, 4405.664997551303, 4497.0, 4524.936639889557, 4527.84152554659, 4543.182227199136, 4557.453105627346, 4401.962645774405, 4408.9118217636105, 4456.264716321771, 4469.240229161115, 4488.483824360241, 4156.0, 4242.2006233674865, 4248.511421186603, 4301.2472817257485, 4317.309230523101, 3137.215696075981, 3176.698213669698, 3229.4509933311865, 3229.935401292008, 3230.6930841570015, 4481.484629267676, 4507.459104907432, 4531.41400509819, 4535.591796738309, 4548.772561371984, 4760.8333708321425, 4878.317035614946, 4896.36347274852, 4945.876353091202, 4998.725070121032, 4967.7516124192925, 4990.126727822544, 4993.377152425403, 4994.275830004702, 4997.375328083989, 4895.412550493964, 4913.312136300992, 4917.181162460737, 4935.506449355035, 4936.506349365035, 4758.286257061469, 4962.900741985212, 5029.471905450021, 5036.974815125901, 5048.495150485069, 4921.557059864629, 4927.926081108714, 4933.186024305949, 4943.777530011086, 4956.306117143531], "value": 3638.4308799673354, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [582.478681579986, 584.8187062010775, 662.6487961380467, 673.9991113196899, 711.3988679565769, 12086.879131208696, 12739.235645861254, 12767.29779862106, 12774.0, 12775.169613975097, 12661.303628300462, 12699.4920203192, 12729.363531823417, 12737.554185603505, 12750.979921606273, 604.6311749832598, 617.3857012272772, 716.0977168767339, 718.8310746974457, 737.5427235114237, 744.0401881572792, 746.4066067476342, 746.723712226477, 746.9066366704162, 747.1631772414903, 785.9135495095535, 787.0712559180165, 787.5668382389663, 787.7991112266365, 787.8384931089141, 621.2110619513215, 638.2723694987718, 639.6609796807653, 639.9232092148925, 781.4256521456725, 473.5217430395291, 556.4129843015617, 566.2044827018046, 569.9116636921284, 573.0086949577213, 10455.738606534822, 10522.0, 10522.947385263025, 10654.78690426195, 10659.626913058006, 12251.69370765729, 12511.311877846714, 12586.370681465982, 12707.618771436872, 13273.876699058203, 8918.420302680304, 9112.772180695469, 10703.892961070445, 10891.400972946485, 10901.890981090168, 4071.5521292657786, 4085.3667681509414, 4123.3196522573735, 4190.979045104786, 4294.935575966363, 61957.07064394083, 62411.0, 63203.367966320206, 63799.0, 64455.35544644587, 10096.091351778228, 10121.696349109392, 10164.440955747505, 10252.333598316085, 10345.534450949724, 17530.211140498708, 17554.473365799047, 17561.56096097608, 17608.55978600545, 17656.55858603545, 6763.222229443579, 6951.27011663768, 7041.683124259421, 7044.7534336299, 7162.7493037743425, 3765.246950609889, 3776.6412190841825, 3798.7530810497783, 3859.286032084073, 3917.4515567820526, 2822.731840475152, 2937.4859399604984, 2960.6891276416095, 2965.466216081083, 2967.940641187164, 501.5836855410001, 505.8254902058784, 505.91146549353715, 512.075703355447, 545.3809925734241, 491.15766460520376, 548.7091841324104, 561.1890817768367, 577.933537643168, 586.4633860018035, 7570.659320330598, 7713.614319284014, 7739.110002349689, 7847.568383738949, 8035.477693949874, 474.69382248449557, 478.64580210643874, 492.59361027152744, 494.30303272385765, 511.88482591416636, 3613.5483064616924, 3871.6515513603913, 3909.765414075108, 3953.347697629916, 4081.3469844824685, 102778.0, 104524.0, 106152.46923765332, 108205.45897270463, 109228.4538577302, 54028.72985635047, 67123.66438167778, 80171.59914200509, 86302.56848715716, 87988.5600571993, 61434.69282653558, 63115.6844215776, 79489.0, 82250.0, 84966.0, 7418.666160022704, 7690.192529784292, 7852.803679908048, 8180.263776260165, 8633.784155396166, 38057.0, 38481.0, 40889.0, 42882.0, 45255.54744452513, 39194.412083819334, 40046.59953400429, 49113.01773964572, 58619.70690146522, 60904.39095608987, 10854.510328429125, 11077.0, 11195.2723073, 11342.092632589209, 11350.091992640733, 11907.0, 12247.632571022883, 13195.60413187606, 13211.537596184087, 13223.471061157446, 11551.768964620493, 11620.941895290807, 11710.824337635113, 11911.702207444536, 12573.245605263714, 10915.890841091805, 11164.888351116384, 11165.776684466427, 11580.768384632092, 11858.703532411413, 10207.540660670436, 10343.689689309333, 10473.528691208761, 10905.0, 11067.280626759235, 9424.623015079595, 9633.662821801203, 9868.309218354647, 10009.0, 10221.488925553544, 9579.233661307218, 10247.180225582084, 10310.123639490428, 10337.0, 10344.32761870476], "value": 6306.845071096238, "unit": "score"}], "name": "dromaeo_css", "value": 6095.29150701681, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 118.0, 114.0, 116.0, 115.0, 117.0, 116.0, 115.0, 115.0, 116.0], "value": 115.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 130.0, 131.0, 160.0, 123.0, 129.0, 122.0, 123.0, 151.0, 127.0], "value": 135.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 160.0, 161.0, 161.0, 161.0, 160.0, 161.0, 161.0, 162.0, 161.0], "value": 160.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 75.0, 108.0, 77.0, 79.0, 77.0, 77.0, 108.0, 78.0], "value": 83.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 136.0, 85.0, 84.0, 84.0, 104.0, 85.0, 84.0, 129.0], "value": 96.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 116.0, 116.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 148.0, 147.0, 147.0, 147.0, 147.0, 147.0, 146.0, 147.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 95.0, 95.0, 94.0, 95.0, 95.0, 94.0, 95.0, 94.0], "value": 94.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 62.0, 63.0, 63.0, 65.0, 65.0, 65.0, 66.0, 64.0, 64.0], "value": 64.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 67.0, 67.0, 66.0, 66.0, 66.0, 66.0, 66.0, 67.0], "value": 66.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 86.0, 83.0, 83.0, 84.0, 83.0, 84.0, 84.0, 82.0, 82.0], "value": 84.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 156.0, 152.0, 134.0, 142.0, 143.0, 135.0, 132.0, 174.0, 131.0], "value": 143.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [180.0, 176.0, 173.0, 176.0, 174.0, 173.0, 172.0, 174.0, 176.0, 171.0], "value": 174.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 69.0, 70.0, 70.0, 70.0, 69.0, 70.0, 68.0, 70.0, 68.0], "value": 69.4, "unit": "score"}], "name": "kraken", "value": 1551.7, "alertThreshold": 2.0}]} 04:38:53 INFO - Return code: 0 04:38:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:38:53 INFO - # TBPL SUCCESS # 04:38:53 INFO - Running post-action listener: _resource_record_post_action 04:38:53 INFO - [mozharness: 2016-09-22 11:38:53.212730Z] Finished run-tests step (success) 04:38:53 INFO - Running post-run listener: _resource_record_post_run 04:38:53 INFO - Total resource usage - Wall time: 1204s; CPU: 13.0%; Read bytes: 0; Write bytes: 390348800; Read time: 0; Write time: 252072 04:38:53 INFO - TinderboxPrint: CPU usage
13.1% 04:38:53 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 04:38:53 INFO - TinderboxPrint: I/O write bytes / time
390,348,800 / 252,072 04:38:53 INFO - TinderboxPrint: CPU idle
8,350.4 (86.9%) 04:38:53 INFO - TinderboxPrint: CPU user
1,206.4 (12.6%) 04:38:53 INFO - TinderboxPrint: Swap in / out
0 / 0 04:38:53 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 99360768; Read time: 0; Write time: 76436 04:38:53 INFO - run-tests - Wall time: 1187s; CPU: 13.0%; Read bytes: 0; Write bytes: 290373632; Read time: 0; Write time: 175636 04:38:53 INFO - Running post-run listener: _upload_blobber_files 04:38:53 INFO - Blob upload gear active. 04:38:53 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:38:53 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 04:38:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:38:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:38:54 INFO - (blobuploader) - INFO - Open directory for files ... 04:38:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 04:38:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:38:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:38:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 04:38:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:38:55 INFO - (blobuploader) - INFO - Done attempting. 04:38:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:38:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:38:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:39:01 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:39:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:39:01 INFO - (blobuploader) - INFO - Done attempting. 04:39:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 04:39:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:39:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:39:02 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 04:39:02 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:39:02 INFO - (blobuploader) - INFO - Done attempting. 04:39:02 INFO - (blobuploader) - INFO - Iteration through files over. 04:39:02 INFO - Return code: 0 04:39:02 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:39:02 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:39:02 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c0891b8c7a4a03872eb7bd5bb52ef881153f8fabb5157b4f229444788856489c73952e9cd2ce43344048fdf10bed1ffa41c0a4cbb79f1dea7d1f83e99bd09b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1c98cbd99d5101fea835fa18881e6811c68dd8171ea2a64e6c5bfca41765fc8d33929a880dd8ee7d940672c693384f75a22d3dd49a1c3d24306b1fbe982288d8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/892c1d51a7add40ed75f5fa254a7bd12394fab9d7100ae9180085499b4791cb1dcfcfb4274550557775b0068aaa0a32fbb07a39732179cc086836194d3394a95"} 04:39:02 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:39:02 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:39:02 INFO - Contents: 04:39:02 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c0891b8c7a4a03872eb7bd5bb52ef881153f8fabb5157b4f229444788856489c73952e9cd2ce43344048fdf10bed1ffa41c0a4cbb79f1dea7d1f83e99bd09b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1c98cbd99d5101fea835fa18881e6811c68dd8171ea2a64e6c5bfca41765fc8d33929a880dd8ee7d940672c693384f75a22d3dd49a1c3d24306b1fbe982288d8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/892c1d51a7add40ed75f5fa254a7bd12394fab9d7100ae9180085499b4791cb1dcfcfb4274550557775b0068aaa0a32fbb07a39732179cc086836194d3394a95"} 04:39:02 INFO - Running post-run listener: copy_logs_to_upload_dir 04:39:02 INFO - Copying logs to upload dir... 04:39:02 INFO - mkdir: /builds/slave/test/build/upload/logs 04:39:02 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.431591 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-09-22 04:39:02.500903) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-22 04:39:02.508082) ========= 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=00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c0891b8c7a4a03872eb7bd5bb52ef881153f8fabb5157b4f229444788856489c73952e9cd2ce43344048fdf10bed1ffa41c0a4cbb79f1dea7d1f83e99bd09b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1c98cbd99d5101fea835fa18881e6811c68dd8171ea2a64e6c5bfca41765fc8d33929a880dd8ee7d940672c693384f75a22d3dd49a1c3d24306b1fbe982288d8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/892c1d51a7add40ed75f5fa254a7bd12394fab9d7100ae9180085499b4791cb1dcfcfb4274550557775b0068aaa0a32fbb07a39732179cc086836194d3394a95"} build_url:https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011202 build_url: 'https://queue.taskcluster.net/v1/task/ZVVeA1JSSyipIo7UDAxaOg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c0891b8c7a4a03872eb7bd5bb52ef881153f8fabb5157b4f229444788856489c73952e9cd2ce43344048fdf10bed1ffa41c0a4cbb79f1dea7d1f83e99bd09b48", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/1c98cbd99d5101fea835fa18881e6811c68dd8171ea2a64e6c5bfca41765fc8d33929a880dd8ee7d940672c693384f75a22d3dd49a1c3d24306b1fbe982288d8", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/892c1d51a7add40ed75f5fa254a7bd12394fab9d7100ae9180085499b4791cb1dcfcfb4274550557775b0068aaa0a32fbb07a39732179cc086836194d3394a95"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-22 04:39:02.536298) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 04:39:02.536657) ========= 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=00204705a9daa57ed339a427000001b9-1474541807.339337-1871953972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004462 ========= master_lag: 0.07 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-22 04:39:02.615601) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-22 04:39:02.618990) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-22 04:39:02.619330) ========= ========= Total master_lag: 0.32 =========