builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-053 starttime: 1503252005.88 results: success (0) revision: cab35526779367774b3ecea2f7a8a5c0993caa77 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:05.875476) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:05.875879) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:05.876144) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:05.911947) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:05.912222) ========= 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=920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-08-20 11:00:06-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 45.9M=0s 2017-08-20 11:00:06 (45.9 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.111562 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.064061) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.064354) ========= 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=920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016806 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.121188) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.127529) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev cab35526779367774b3ecea2f7a8a5c0993caa77 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev cab35526779367774b3ecea2f7a8a5c0993caa77 --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=920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-08-20 11:00:06,736 truncating revision to first 12 chars 2017-08-20 11:00:06,736 Setting DEBUG logging. 2017-08-20 11:00:06,737 attempt 1/10 2017-08-20 11:00:06,737 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/cab355267793?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-20 11:00:07,028 unpacking tar archive at: mozilla-central-cab355267793/testing/mozharness/ program finished with exit code 0 elapsedTime=0.672241 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.814445) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.814741) ========= script_repo_revision: cab35526779367774b3ecea2f7a8a5c0993caa77 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.815107) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.821600) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-20 11:00:06.858686) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2017-08-20 11:00:06.858956) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:00:07 INFO - MultiFileLogger online at 20170820 11:00:07 in /builds/slave/test 11:00:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 11:00:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:00:07 INFO - {'append_to_log': False, 11:00:07 INFO - 'base_work_dir': '/builds/slave/test', 11:00:07 INFO - 'blob_upload_branch': 'Firefox', 11:00:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:00:07 INFO - 'branch': 'Firefox', 11:00:07 INFO - 'buildbot_json_path': 'buildprops.json', 11:00:07 INFO - 'code_coverage': False, 11:00:07 INFO - 'config_files': ('talos/linux_config.py',), 11:00:07 INFO - 'default_actions': ('clobber', 11:00:07 INFO - 'read-buildbot-config', 11:00:07 INFO - 'download-and-extract', 11:00:07 INFO - 'populate-webroot', 11:00:07 INFO - 'create-virtualenv', 11:00:07 INFO - 'install', 11:00:07 INFO - 'setup-mitmproxy', 11:00:07 INFO - 'run-tests'), 11:00:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:00:07 INFO - 'disable_ccov_upload': False, 11:00:07 INFO - 'download_minidump_stackwalk': True, 11:00:07 INFO - 'download_symbols': 'ondemand', 11:00:07 INFO - 'enable_stylo': False, 11:00:07 INFO - 'enable_webrender': False, 11:00:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:00:07 INFO - 'tooltool.py': '/tools/tooltool.py', 11:00:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:00:07 INFO - '/tools/misc-python/virtualenv.py')}, 11:00:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:00:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:00:07 INFO - 'gecko_profile': False, 11:00:07 INFO - 'gecko_profile_interval': 0, 11:00:07 INFO - 'installer_path': 'installer.exe', 11:00:07 INFO - 'log_level': 'info', 11:00:07 INFO - 'log_name': 'talos', 11:00:07 INFO - 'log_to_console': True, 11:00:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:00:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:00:07 INFO - 'opt_config_files': (), 11:00:07 INFO - 'pip_index': False, 11:00:07 INFO - 'suite': 'dromaeojs-e10s', 11:00:07 INFO - 'system_bits': '32', 11:00:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:00:07 INFO - 'title': 'talos-linux64-ix-053', 11:00:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:00:07 INFO - 'use_talos_json': True, 11:00:07 INFO - 'verify': 'False', 11:00:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:00:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:00:07 INFO - 'work_dir': 'build'} 11:00:07 INFO - [mozharness: 2017-08-20 18:00:07.620763Z] Running clobber step. 11:00:07 INFO - Running pre-action listener: _resource_record_pre_action 11:00:07 INFO - Running main action method: clobber 11:00:07 INFO - rmtree: /builds/slave/test/build 11:00:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:00:09 INFO - Running post-action listener: _resource_record_post_action 11:00:09 INFO - [mozharness: 2017-08-20 18:00:09.164476Z] Finished clobber step (success) 11:00:09 INFO - [mozharness: 2017-08-20 18:00:09.164573Z] Running read-buildbot-config step. 11:00:09 INFO - Running pre-action listener: _resource_record_pre_action 11:00:09 INFO - Running main action method: read_buildbot_config 11:00:09 INFO - Using buildbot properties: 11:00:09 INFO - { 11:00:09 INFO - "project": "", 11:00:09 INFO - "product": "firefox", 11:00:09 INFO - "who": "ffxbld@noreply.mozilla.org", 11:00:09 INFO - "installer_path": "public/build/target.tar.bz2", 11:00:09 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 11:00:09 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 11:00:09 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 11:00:09 INFO - "stage_platform": "linux64-stylo", 11:00:09 INFO - "basedir": "/builds/slave/test", 11:00:09 INFO - "buildnumber": 45, 11:00:09 INFO - "platform": "ubuntu64_hw_stylo", 11:00:09 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 11:00:09 INFO - "slavebuilddir": "test", 11:00:09 INFO - "taskId": "CMj6MX2SSUS57bL9h8ihuQ", 11:00:09 INFO - "branch": "mozilla-central", 11:00:09 INFO - "script_repo_revision": "production", 11:00:09 INFO - "revision": "cab35526779367774b3ecea2f7a8a5c0993caa77", 11:00:09 INFO - "slavename": "talos-linux64-ix-053", 11:00:09 INFO - "repo_path": "mozilla-central" 11:00:09 INFO - } 11:00:09 INFO - Finding installer, test and symbols from parent task. 11:00:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/CMj6MX2SSUS57bL9h8ihuQ'}, attempt #1 11:00:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/CMj6MX2SSUS57bL9h8ihuQ'}, attempt #1 11:00:10 INFO - Task dependencies: LJxQRdN-QvOV7_FMIYAiQw 11:00:10 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw'}, attempt #1 11:00:10 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2 11:00:10 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.test_packages.json 11:00:10 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.crashreporter-symbols.zip 11:00:10 INFO - Running post-action listener: _resource_record_post_action 11:00:10 INFO - [mozharness: 2017-08-20 18:00:10.523872Z] Finished read-buildbot-config step (success) 11:00:10 INFO - [mozharness: 2017-08-20 18:00:10.524089Z] Running download-and-extract step. 11:00:10 INFO - Running pre-action listener: _resource_record_pre_action 11:00:10 INFO - Running main action method: download_and_extract 11:00:10 INFO - mkdir: /builds/slave/test/build/tests 11:00:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:10 INFO - trying https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.test_packages.json 11:00:10 INFO - Downloading https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 11:00:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 11:00:13 INFO - Downloaded 989 bytes. 11:00:13 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 11:00:13 INFO - Using the following test package requirements: 11:00:13 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 11:00:13 INFO - u'common': [u'target.common.tests.zip'], 11:00:13 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 11:00:13 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 11:00:13 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 11:00:13 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 11:00:13 INFO - u'mozbase': [u'target.common.tests.zip'], 11:00:13 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 11:00:13 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 11:00:13 INFO - u'web-platform': [u'target.common.tests.zip', 11:00:13 INFO - u'target.web-platform.tests.tar.gz'], 11:00:13 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 11:00:13 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 11:00:13 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.common.tests.zip 11:00:13 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.common.tests.zip'}, attempt #1 11:00:13 INFO - Fetch https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.common.tests.zip into memory 11:00:17 INFO - Content-Length response header: 54005753 11:00:17 INFO - Bytes received: 54005753 11:00:28 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 11:00:28 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.common.tests.zip 11:00:28 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.common.tests.zip'}, attempt #1 11:00:28 INFO - Fetch https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.common.tests.zip into memory 11:00:30 INFO - Content-Length response header: 54005753 11:00:30 INFO - Bytes received: 54005753 11:00:42 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.talos.tests.zip 11:00:42 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 11:00:42 INFO - Fetch https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.talos.tests.zip into memory 11:00:43 INFO - Content-Length response header: 14496256 11:00:43 INFO - Bytes received: 14496256 11:00:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:44 INFO - trying https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2 11:00:44 INFO - Downloading https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 11:00:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 11:00:47 INFO - Downloaded 62146911 bytes. 11:00:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2 11:00:47 INFO - mkdir: /builds/slave/test/properties 11:00:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:00:47 INFO - Writing to file /builds/slave/test/properties/build_url 11:00:47 INFO - Contents: 11:00:47 INFO - build_url:https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2 11:00:47 INFO - Running post-action listener: _resource_record_post_action 11:00:47 INFO - Running post-action listener: find_tests_for_verification 11:00:47 INFO - Running post-action listener: set_extra_try_arguments 11:00:47 INFO - [mozharness: 2017-08-20 18:00:47.794861Z] Finished download-and-extract step (success) 11:00:47 INFO - [mozharness: 2017-08-20 18:00:47.795105Z] Running populate-webroot step. 11:00:47 INFO - Running pre-action listener: _resource_record_pre_action 11:00:47 INFO - Running main action method: populate_webroot 11:00:47 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:00:47 INFO - 'chromez-stylo-e10s': {'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:00:47 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:00:47 INFO - 'dromaeojs-stylo-e10s': {'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:00:47 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:00:47 INFO - 'g1-stylo-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:00:47 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'tests': ['damp', 'tps']}, 11:00:47 INFO - 'g2-stylo-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['damp', 'tps']}, 11:00:47 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:00:47 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 11:00:47 INFO - 'g4-stylo-e10s': {'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 11:00:47 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 11:00:47 INFO - 'g5-stylo-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 11:00:47 INFO - 'other-e10s': {'tests': ['a11yr', 11:00:47 INFO - 'ts_paint', 11:00:47 INFO - 'tpaint', 11:00:47 INFO - 'sessionrestore', 11:00:47 INFO - 'sessionrestore_many_windows', 11:00:47 INFO - 'sessionrestore_no_auto_restore', 11:00:47 INFO - 'tabpaint']}, 11:00:47 INFO - 'other-stylo-e10s': {'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['a11yr', 11:00:47 INFO - 'ts_paint', 11:00:47 INFO - 'tpaint', 11:00:47 INFO - 'sessionrestore', 11:00:47 INFO - 'sessionrestore_many_windows', 11:00:47 INFO - 'sessionrestore_no_auto_restore', 11:00:47 INFO - 'tabpaint']}, 11:00:47 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 11:00:47 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 11:00:47 INFO - 'perf-reftest-singletons-stylo-e10s': {'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['bloom_basic_singleton']}, 11:00:47 INFO - 'perf-reftest-stylo-e10s': {'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['bloom_basic']}, 11:00:47 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:00:47 INFO - 'tsvgr_opacity', 11:00:47 INFO - 'tart', 11:00:47 INFO - 'tscrollx', 11:00:47 INFO - 'tsvg_static']}, 11:00:47 INFO - 'svgr-stylo-e10s': {'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['tsvgx', 11:00:47 INFO - 'tsvgr_opacity', 11:00:47 INFO - 'tart', 11:00:47 INFO - 'tscrollx', 11:00:47 INFO - 'tsvg_static']}, 11:00:47 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 11:00:47 INFO - 'tp5o-stylo-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'talos_options': ['--stylo'], 11:00:47 INFO - 'tests': ['tp5o']}, 11:00:47 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 11:00:47 INFO - 'talos_options': ['--mitmproxy', 11:00:47 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 11:00:47 INFO - '--firstNonBlankPaint'], 11:00:47 INFO - 'tests': ['tp6_google', 11:00:47 INFO - 'tp6_youtube', 11:00:47 INFO - 'tp6_amazon', 11:00:47 INFO - 'tp6_facebook']}, 11:00:47 INFO - 'tp6-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 11:00:47 INFO - 'talos_options': ['--stylo', 11:00:47 INFO - '--mitmproxy', 11:00:47 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 11:00:47 INFO - '--firstNonBlankPaint'], 11:00:47 INFO - 'tests': ['tp6_google', 11:00:47 INFO - 'tp6_youtube', 11:00:47 INFO - 'tp6_amazon', 11:00:47 INFO - 'tp6_facebook']}, 11:00:47 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 11:00:47 INFO - 'talos_options': ['--stylo', 11:00:47 INFO - '--stylo-threads=1', 11:00:47 INFO - '--mitmproxy', 11:00:47 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 11:00:47 INFO - '--firstNonBlankPaint'], 11:00:47 INFO - 'tests': ['tp6_google', 11:00:47 INFO - 'tp6_youtube', 11:00:47 INFO - 'tp6_amazon', 11:00:47 INFO - 'tp6_facebook']}, 11:00:47 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'talos_options': ['--xperf_path', 11:00:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:00:47 INFO - 'tests': ['tp5n']}, 11:00:47 INFO - 'xperf-stylo-e10s': {'pagesets_name': 'tp5n.zip', 11:00:47 INFO - 'talos_options': ['--stylo', 11:00:47 INFO - '--xperf_path', 11:00:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:00:47 INFO - 'tests': ['tp5n']}}} 11:00:47 INFO - Running post-action listener: _resource_record_post_action 11:00:47 INFO - [mozharness: 2017-08-20 18:00:47.811908Z] Finished populate-webroot step (success) 11:00:47 INFO - [mozharness: 2017-08-20 18:00:47.811998Z] Running create-virtualenv step. 11:00:47 INFO - Running pre-action listener: _resource_record_pre_action 11:00:47 INFO - Running main action method: create_virtualenv 11:00:47 INFO - Creating virtualenv /builds/slave/test/build/venv 11:00:47 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 11:00:47 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:00:47 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 11:00:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:00:47 INFO - Using real prefix '/usr' 11:00:47 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:00:48 INFO - Installing distribute.............................................................................................................................................................................................done. 11:00:50 INFO - Installing pip.................done. 11:00:50 INFO - Return code: 0 11:00:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 11:00:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 11:00:50 INFO - Reading from file tmpfile_stdout 11:00:50 INFO - Output received: 11:00:50 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 11:00:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:00:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:00:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:00:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 11:00:50 INFO - Using env: {'DISPLAY': ':0', 11:00:50 INFO - 'HOME': '/home/cltbld', 11:00:50 INFO - 'LANG': 'en_US.UTF-8', 11:00:50 INFO - 'LANGUAGE': 'en_US:en', 11:00:50 INFO - 'LOGNAME': 'cltbld', 11:00:50 INFO - 'MAIL': '/var/mail/cltbld', 11:00:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:50 INFO - 'MOZ_NO_REMOTE': '1', 11:00:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:50 INFO - 'NO_EM_RESTART': '1', 11:00:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:00:50 INFO - 'PWD': '/builds/slave/test', 11:00:50 INFO - 'SHELL': '/bin/bash', 11:00:50 INFO - 'SHLVL': '1', 11:00:50 INFO - 'TERM': 'linux', 11:00:50 INFO - 'TMOUT': '86400', 11:00:50 INFO - 'USER': 'cltbld', 11:00:50 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:00:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:50 INFO - '_': '/tools/buildbot/bin/python'} 11:00:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:50 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 11:00:50 INFO - Cleaning up... 11:00:50 INFO - Return code: 0 11:00:50 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:00:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:00:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:00:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 11:00:50 INFO - Using env: {'DISPLAY': ':0', 11:00:50 INFO - 'HOME': '/home/cltbld', 11:00:50 INFO - 'LANG': 'en_US.UTF-8', 11:00:50 INFO - 'LANGUAGE': 'en_US:en', 11:00:50 INFO - 'LOGNAME': 'cltbld', 11:00:50 INFO - 'MAIL': '/var/mail/cltbld', 11:00:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:50 INFO - 'MOZ_NO_REMOTE': '1', 11:00:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:50 INFO - 'NO_EM_RESTART': '1', 11:00:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:00:50 INFO - 'PWD': '/builds/slave/test', 11:00:50 INFO - 'SHELL': '/bin/bash', 11:00:50 INFO - 'SHLVL': '1', 11:00:50 INFO - 'TERM': 'linux', 11:00:50 INFO - 'TMOUT': '86400', 11:00:50 INFO - 'USER': 'cltbld', 11:00:50 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:00:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:50 INFO - '_': '/tools/buildbot/bin/python'} 11:00:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:51 INFO - Downloading/unpacking psutil>=3.1.1 11:00:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:00:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:00:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:00:52 INFO - Installing collected packages: psutil 11:00:52 INFO - Running setup.py install for psutil 11:00:52 INFO - building 'psutil._psutil_linux' extension 11:00:52 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 11:00:52 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 11:00:52 INFO - building 'psutil._psutil_posix' extension 11:00:52 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 11:00:52 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 11:00:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:00:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:00:52 INFO - Successfully installed psutil 11:00:52 INFO - Cleaning up... 11:00:52 INFO - Return code: 0 11:00:52 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:00:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:52 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:00:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:00:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 11:00:52 INFO - Using env: {'DISPLAY': ':0', 11:00:52 INFO - 'HOME': '/home/cltbld', 11:00:52 INFO - 'LANG': 'en_US.UTF-8', 11:00:52 INFO - 'LANGUAGE': 'en_US:en', 11:00:52 INFO - 'LOGNAME': 'cltbld', 11:00:52 INFO - 'MAIL': '/var/mail/cltbld', 11:00:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:52 INFO - 'MOZ_NO_REMOTE': '1', 11:00:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:52 INFO - 'NO_EM_RESTART': '1', 11:00:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:00:52 INFO - 'PWD': '/builds/slave/test', 11:00:52 INFO - 'SHELL': '/bin/bash', 11:00:52 INFO - 'SHLVL': '1', 11:00:52 INFO - 'TERM': 'linux', 11:00:52 INFO - 'TMOUT': '86400', 11:00:52 INFO - 'USER': 'cltbld', 11:00:52 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:00:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:52 INFO - '_': '/tools/buildbot/bin/python'} 11:00:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:52 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:00:52 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 11:00:52 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 11:00:52 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 11:00:52 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 11:00:54 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:00:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:00:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:00:54 INFO - Installing collected packages: mozsystemmonitor 11:00:54 INFO - Running setup.py install for mozsystemmonitor 11:00:54 INFO - Successfully installed mozsystemmonitor 11:00:54 INFO - Cleaning up... 11:00:54 INFO - Return code: 0 11:00:54 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:00:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:54 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:00:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:00:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 11:00:54 INFO - Using env: {'DISPLAY': ':0', 11:00:54 INFO - 'HOME': '/home/cltbld', 11:00:54 INFO - 'LANG': 'en_US.UTF-8', 11:00:54 INFO - 'LANGUAGE': 'en_US:en', 11:00:54 INFO - 'LOGNAME': 'cltbld', 11:00:54 INFO - 'MAIL': '/var/mail/cltbld', 11:00:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:54 INFO - 'MOZ_NO_REMOTE': '1', 11:00:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:54 INFO - 'NO_EM_RESTART': '1', 11:00:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:00:54 INFO - 'PWD': '/builds/slave/test', 11:00:54 INFO - 'SHELL': '/bin/bash', 11:00:54 INFO - 'SHLVL': '1', 11:00:54 INFO - 'TERM': 'linux', 11:00:54 INFO - 'TMOUT': '86400', 11:00:54 INFO - 'USER': 'cltbld', 11:00:54 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:00:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:54 INFO - '_': '/tools/buildbot/bin/python'} 11:00:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:54 INFO - Downloading/unpacking jsonschema==2.5.1 11:00:54 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 11:00:54 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 11:00:54 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 11:00:54 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 11:00:55 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:00:55 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:00:55 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 11:00:55 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 11:00:55 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 11:00:55 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 11:00:55 INFO - Downloading functools32-3.2.3-2.tar.gz 11:00:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:00:55 INFO - warning: no files found matching '*.txt' 11:00:55 INFO - no previously-included directories found matching 'build' 11:00:55 INFO - no previously-included directories found matching 'dist' 11:00:55 INFO - no previously-included directories found matching '.git*' 11:00:55 INFO - Installing collected packages: jsonschema, functools32 11:00:55 INFO - Running setup.py install for functools32 11:00:55 INFO - warning: no files found matching '*.txt' 11:00:55 INFO - no previously-included directories found matching 'build' 11:00:55 INFO - no previously-included directories found matching 'dist' 11:00:55 INFO - no previously-included directories found matching '.git*' 11:00:55 INFO - Successfully installed jsonschema functools32 11:00:55 INFO - Cleaning up... 11:00:56 INFO - Return code: 0 11:00:56 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 11:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:56 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:00:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:00:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 11:00:56 INFO - Using env: {'DISPLAY': ':0', 11:00:56 INFO - 'HOME': '/home/cltbld', 11:00:56 INFO - 'LANG': 'en_US.UTF-8', 11:00:56 INFO - 'LANGUAGE': 'en_US:en', 11:00:56 INFO - 'LOGNAME': 'cltbld', 11:00:56 INFO - 'MAIL': '/var/mail/cltbld', 11:00:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:56 INFO - 'MOZ_NO_REMOTE': '1', 11:00:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:56 INFO - 'NO_EM_RESTART': '1', 11:00:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:00:56 INFO - 'PWD': '/builds/slave/test', 11:00:56 INFO - 'SHELL': '/bin/bash', 11:00:56 INFO - 'SHLVL': '1', 11:00:56 INFO - 'TERM': 'linux', 11:00:56 INFO - 'TMOUT': '86400', 11:00:56 INFO - 'USER': 'cltbld', 11:00:56 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:00:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:56 INFO - '_': '/tools/buildbot/bin/python'} 11:00:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:56 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 11:00:56 INFO - Cleaning up... 11:00:56 INFO - Return code: 0 11:00:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:56 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:00:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:00:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 11:00:56 INFO - Using env: {'DISPLAY': ':0', 11:00:56 INFO - 'HOME': '/home/cltbld', 11:00:56 INFO - 'LANG': 'en_US.UTF-8', 11:00:56 INFO - 'LANGUAGE': 'en_US:en', 11:00:56 INFO - 'LOGNAME': 'cltbld', 11:00:56 INFO - 'MAIL': '/var/mail/cltbld', 11:00:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:56 INFO - 'MOZ_NO_REMOTE': '1', 11:00:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:56 INFO - 'NO_EM_RESTART': '1', 11:00:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:00:56 INFO - 'PWD': '/builds/slave/test', 11:00:56 INFO - 'SHELL': '/bin/bash', 11:00:56 INFO - 'SHLVL': '1', 11:00:56 INFO - 'TERM': 'linux', 11:00:56 INFO - 'TMOUT': '86400', 11:00:56 INFO - 'USER': 'cltbld', 11:00:56 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:00:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:56 INFO - '_': '/tools/buildbot/bin/python'} 11:00:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:56 INFO - Downloading/unpacking blobuploader==1.2.4 11:00:56 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 11:00:56 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 11:00:56 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 11:00:56 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 11:00:57 INFO - Downloading blobuploader-1.2.4.tar.gz 11:00:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:00:57 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:00:57 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 11:00:57 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 11:00:57 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 11:00:57 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 11:00:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:00:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:00:57 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 11:00:57 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 11:00:57 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 11:00:57 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 11:00:58 INFO - Downloading docopt-0.6.1.tar.gz 11:00:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:00:58 INFO - Installing collected packages: blobuploader, requests, docopt 11:00:58 INFO - Running setup.py install for blobuploader 11:00:58 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:00:58 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:00:58 INFO - Running setup.py install for requests 11:00:58 INFO - Running setup.py install for docopt 11:00:58 INFO - Successfully installed blobuploader requests docopt 11:00:58 INFO - Cleaning up... 11:00:58 INFO - Return code: 0 11:00:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:00:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:00:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:58 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:00:58 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:00:58 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:00:58 INFO - Using env: {'DISPLAY': ':0', 11:00:58 INFO - 'HOME': '/home/cltbld', 11:00:58 INFO - 'LANG': 'en_US.UTF-8', 11:00:58 INFO - 'LANGUAGE': 'en_US:en', 11:00:58 INFO - 'LOGNAME': 'cltbld', 11:00:58 INFO - 'MAIL': '/var/mail/cltbld', 11:00:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:58 INFO - 'MOZ_NO_REMOTE': '1', 11:00:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:58 INFO - 'NO_EM_RESTART': '1', 11:00:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:00:58 INFO - 'PWD': '/builds/slave/test', 11:00:58 INFO - 'SHELL': '/bin/bash', 11:00:58 INFO - 'SHLVL': '1', 11:00:58 INFO - 'TERM': 'linux', 11:00:58 INFO - 'TMOUT': '86400', 11:00:58 INFO - 'USER': 'cltbld', 11:00:58 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:00:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:58 INFO - '_': '/tools/buildbot/bin/python'} 11:00:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:00:58 INFO - Running setup.py (path:/tmp/pip-94Qom6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:00:59 INFO - Running setup.py (path:/tmp/pip-ZZQeGw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:00:59 INFO - Running setup.py (path:/tmp/pip-thFcuZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:00:59 INFO - Running setup.py (path:/tmp/pip-qOQQys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:00:59 INFO - Running setup.py (path:/tmp/pip-ysJF7j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:00:59 INFO - Running setup.py (path:/tmp/pip-8yVdDV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:00:59 INFO - Running setup.py (path:/tmp/pip-7M0bsq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:00:59 INFO - Running setup.py (path:/tmp/pip-Burn9G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:00:59 INFO - Running setup.py (path:/tmp/pip-hQ_0sI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:00:59 INFO - Running setup.py (path:/tmp/pip-L0X5xF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:00:59 INFO - Running setup.py (path:/tmp/pip-iHcNgy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:00:59 INFO - Running setup.py (path:/tmp/pip-z7M7GY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:00:59 INFO - Running setup.py (path:/tmp/pip-I9rUgz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:00:59 INFO - Running setup.py (path:/tmp/pip-em8mkD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:00:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:00:59 INFO - Running setup.py (path:/tmp/pip-x1nyA4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:01:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:01:00 INFO - Running setup.py (path:/tmp/pip-86UrlR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:01:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:01:00 INFO - Running setup.py (path:/tmp/pip-BzeaFC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:01:00 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:01:00 INFO - Running setup.py install for manifestparser 11:01:00 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Running setup.py install for mozcrash 11:01:00 INFO - Running setup.py install for mozdebug 11:01:00 INFO - Running setup.py install for mozdevice 11:01:00 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Running setup.py install for mozfile 11:01:00 INFO - Running setup.py install for mozhttpd 11:01:00 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Running setup.py install for mozinfo 11:01:00 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Running setup.py install for mozInstall 11:01:00 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:01:00 INFO - Running setup.py install for mozleak 11:01:01 INFO - Running setup.py install for mozlog 11:01:01 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:01:01 INFO - Running setup.py install for moznetwork 11:01:01 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:01:01 INFO - Running setup.py install for mozprocess 11:01:01 INFO - Running setup.py install for mozprofile 11:01:01 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:01:01 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:01:01 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:01:01 INFO - Running setup.py install for mozrunner 11:01:01 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:01:01 INFO - Running setup.py install for mozscreenshot 11:01:01 INFO - Running setup.py install for moztest 11:01:01 INFO - Running setup.py install for mozversion 11:01:01 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:01:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:01:01 INFO - Cleaning up... 11:01:01 INFO - Return code: 0 11:01:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:01:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:01:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:01:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:01:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:01:02 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:01:02 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:01:02 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:01:02 INFO - Using env: {'DISPLAY': ':0', 11:01:02 INFO - 'HOME': '/home/cltbld', 11:01:02 INFO - 'LANG': 'en_US.UTF-8', 11:01:02 INFO - 'LANGUAGE': 'en_US:en', 11:01:02 INFO - 'LOGNAME': 'cltbld', 11:01:02 INFO - 'MAIL': '/var/mail/cltbld', 11:01:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:01:02 INFO - 'MOZ_NO_REMOTE': '1', 11:01:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:01:02 INFO - 'NO_EM_RESTART': '1', 11:01:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:01:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:01:02 INFO - 'PWD': '/builds/slave/test', 11:01:02 INFO - 'SHELL': '/bin/bash', 11:01:02 INFO - 'SHLVL': '1', 11:01:02 INFO - 'TERM': 'linux', 11:01:02 INFO - 'TMOUT': '86400', 11:01:02 INFO - 'USER': 'cltbld', 11:01:02 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:01:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:01:02 INFO - '_': '/tools/buildbot/bin/python'} 11:01:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:01:02 INFO - Running setup.py (path:/tmp/pip-F8U0E8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:01:02 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:01:02 INFO - Running setup.py (path:/tmp/pip-DfSQg3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:01:02 INFO - Running setup.py (path:/tmp/pip-Djugm_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:01:02 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:01:02 INFO - Running setup.py (path:/tmp/pip-T42DRG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:01:02 INFO - Running setup.py (path:/tmp/pip-N0dX_H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:01:02 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:01:02 INFO - Running setup.py (path:/tmp/pip-FADCqt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:01:02 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:01:02 INFO - Running setup.py (path:/tmp/pip-KHlDNk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:01:02 INFO - Running setup.py (path:/tmp/pip-i0gepZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:01:02 INFO - Running setup.py (path:/tmp/pip-KhFqyl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:01:02 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)) 11:01:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:01:02 INFO - Running setup.py (path:/tmp/pip-jQveWT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:01:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 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)) 11:01:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:01:03 INFO - Running setup.py (path:/tmp/pip-V4vyv3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:01:03 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)) 11:01:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:01:03 INFO - Running setup.py (path:/tmp/pip-zpMEJW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:01:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 11:01:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:01:03 INFO - Running setup.py (path:/tmp/pip-3ztPNh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:01:03 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)) 11:01:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:01:03 INFO - Running setup.py (path:/tmp/pip-7Vrq16-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:01:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 11:01:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:01:03 INFO - Running setup.py (path:/tmp/pip-CDEmkz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:01:03 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)) 11:01:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:01:03 INFO - Running setup.py (path:/tmp/pip-G4gEtm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:01:03 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 11:01:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:01:03 INFO - Running setup.py (path:/tmp/pip-UvAOjd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:01:03 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)) 11:01:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:01:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:01:03 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)) 11:01:03 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.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:01:03 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.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:01:03 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 11:01:03 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:01:03 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 11:01:03 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 11:01:03 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 11:01:03 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 11:01:04 INFO - Downloading blessings-1.6.tar.gz 11:01:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:01:04 INFO - Installing collected packages: blessings 11:01:04 INFO - Running setup.py install for blessings 11:01:04 INFO - Successfully installed blessings 11:01:04 INFO - Cleaning up... 11:01:05 INFO - Return code: 0 11:01:05 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:01:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:01:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:01:05 INFO - Reading from file tmpfile_stdout 11:01:05 INFO - Current package versions: 11:01:05 INFO - argparse == 1.2.1 11:01:05 INFO - blessings == 1.6 11:01:05 INFO - blobuploader == 1.2.4 11:01:05 INFO - docopt == 0.6.1 11:01:05 INFO - functools32 == 3.2.3-2 11:01:05 INFO - jsonschema == 2.5.1 11:01:05 INFO - manifestparser == 1.1 11:01:05 INFO - mozInstall == 1.13 11:01:05 INFO - mozcrash == 1.0 11:01:05 INFO - mozdebug == 0.1 11:01:05 INFO - mozdevice == 0.51 11:01:05 INFO - mozfile == 1.2 11:01:05 INFO - mozhttpd == 0.7 11:01:05 INFO - mozinfo == 0.10 11:01:05 INFO - mozleak == 0.1 11:01:05 INFO - mozlog == 3.5 11:01:05 INFO - moznetwork == 0.27 11:01:05 INFO - mozprocess == 0.25 11:01:05 INFO - mozprofile == 0.28 11:01:05 INFO - mozrunner == 6.13 11:01:05 INFO - mozscreenshot == 0.1 11:01:05 INFO - mozsystemmonitor == 0.3 11:01:05 INFO - moztest == 0.8 11:01:05 INFO - mozversion == 1.4 11:01:05 INFO - psutil == 3.1.1 11:01:05 INFO - requests == 1.2.3 11:01:05 INFO - wsgiref == 0.1.2 11:01:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:01:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:01:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:01:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:01:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:01:05 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:01:05 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 11:01:05 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:01:05 INFO - Using env: {'DISPLAY': ':0', 11:01:05 INFO - 'HOME': '/home/cltbld', 11:01:05 INFO - 'LANG': 'en_US.UTF-8', 11:01:05 INFO - 'LANGUAGE': 'en_US:en', 11:01:05 INFO - 'LOGNAME': 'cltbld', 11:01:05 INFO - 'MAIL': '/var/mail/cltbld', 11:01:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:01:05 INFO - 'MOZ_NO_REMOTE': '1', 11:01:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:01:05 INFO - 'NO_EM_RESTART': '1', 11:01:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:01:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:01:05 INFO - 'PWD': '/builds/slave/test', 11:01:05 INFO - 'SHELL': '/bin/bash', 11:01:05 INFO - 'SHLVL': '1', 11:01:05 INFO - 'TERM': 'linux', 11:01:05 INFO - 'TMOUT': '86400', 11:01:05 INFO - 'USER': 'cltbld', 11:01:05 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:01:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:01:05 INFO - '_': '/tools/buildbot/bin/python'} 11:01:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:01:05 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)) 11:01:05 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)) 11:01:05 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)) 11:01:05 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)) 11:01:05 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)) 11:01:05 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)) 11:01:05 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)) 11:01:05 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)) 11:01:05 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)) 11:01:05 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 11:01:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:01:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:01:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:01:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:01:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 11:01:06 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)) 11:01:06 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)) 11:01:06 INFO - Installing collected packages: simplejson 11:01:06 INFO - Running setup.py install for simplejson 11:01:07 INFO - building 'simplejson._speedups' extension 11:01:07 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 11:01:07 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 11:01:07 INFO - Successfully installed simplejson 11:01:07 INFO - Cleaning up... 11:01:07 INFO - Return code: 0 11:01:07 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:01:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:01:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:01:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:01:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:01:08 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/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 0x200d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21d8a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237bf90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, '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': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', '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 11:01:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 11:01:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 11:01:08 INFO - Using env: {'DISPLAY': ':0', 11:01:08 INFO - 'HOME': '/home/cltbld', 11:01:08 INFO - 'LANG': 'en_US.UTF-8', 11:01:08 INFO - 'LANGUAGE': 'en_US:en', 11:01:08 INFO - 'LOGNAME': 'cltbld', 11:01:08 INFO - 'MAIL': '/var/mail/cltbld', 11:01:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:01:08 INFO - 'MOZ_NO_REMOTE': '1', 11:01:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:01:08 INFO - 'NO_EM_RESTART': '1', 11:01:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:01:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:01:08 INFO - 'PWD': '/builds/slave/test', 11:01:08 INFO - 'SHELL': '/bin/bash', 11:01:08 INFO - 'SHLVL': '1', 11:01:08 INFO - 'TERM': 'linux', 11:01:08 INFO - 'TMOUT': '86400', 11:01:08 INFO - 'USER': 'cltbld', 11:01:08 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:01:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:01:08 INFO - '_': '/tools/buildbot/bin/python'} 11:01:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:01:08 INFO - Cleaning up... 11:01:08 INFO - Return code: 0 11:01:08 INFO - Running post-action listener: _resource_record_post_action 11:01:08 INFO - Running post-action listener: _start_resource_monitoring 11:01:08 INFO - Starting resource monitoring. 11:01:08 INFO - [mozharness: 2017-08-20 18:01:08.275344Z] Finished create-virtualenv step (success) 11:01:08 INFO - [mozharness: 2017-08-20 18:01:08.275808Z] Running install step. 11:01:08 INFO - Running pre-action listener: _resource_record_pre_action 11:01:08 INFO - Running main action method: install 11:01:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:01:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:01:08 INFO - Reading from file tmpfile_stdout 11:01:08 INFO - Detecting whether we're running mozinstall >=1.0... 11:01:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:01:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:01:08 INFO - Reading from file tmpfile_stdout 11:01:08 INFO - Output received: 11:01:08 INFO - Usage: mozinstall [options] installer 11:01:08 INFO - Options: 11:01:08 INFO - -h, --help show this help message and exit 11:01:08 INFO - -d DEST, --destination=DEST 11:01:08 INFO - Directory to install application into. [default: 11:01:08 INFO - "/builds/slave/test"] 11:01:08 INFO - --app=APP Application being installed. [default: firefox] 11:01:08 INFO - mkdir: /builds/slave/test/build/application 11:01:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 11:01:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 11:01:26 INFO - Reading from file tmpfile_stdout 11:01:26 INFO - Output received: 11:01:26 INFO - /builds/slave/test/build/application/firefox/firefox 11:01:26 INFO - Running post-action listener: _resource_record_post_action 11:01:26 INFO - [mozharness: 2017-08-20 18:01:26.616427Z] Finished install step (success) 11:01:26 INFO - [mozharness: 2017-08-20 18:01:26.616709Z] Running setup-mitmproxy step. 11:01:26 INFO - Running pre-action listener: _resource_record_pre_action 11:01:26 INFO - Running main action method: setup_mitmproxy 11:01:26 INFO - Skipping: mitmproxy is not required 11:01:26 INFO - Running post-action listener: _resource_record_post_action 11:01:26 INFO - [mozharness: 2017-08-20 18:01:26.617844Z] Finished setup-mitmproxy step (success) 11:01:26 INFO - [mozharness: 2017-08-20 18:01:26.618064Z] Running run-tests step. 11:01:26 INFO - Running pre-action listener: _resource_record_pre_action 11:01:26 INFO - Running pre-action listener: _set_gcov_prefix 11:01:26 INFO - Running main action method: run_tests 11:01:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:01:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:01:26 INFO - Python 2.7.3 11:01:26 INFO - Return code: 0 11:01:26 INFO - grabbing minidump binary from tooltool 11:01:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 11:01:26 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 0x2379130>, '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 0x237a030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x237a4c0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:01:26 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 11:01:26 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 11:01:26 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 11:01:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:01:26 INFO - Return code: 0 11:01:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:01:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:01:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:01:26 INFO - ENV: RUST_BACKTRACE is now full 11:01:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:01:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:01:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 11:01:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-053 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 11:01:26 INFO - Using env: {'DISPLAY': ':0', 11:01:26 INFO - 'HOME': '/home/cltbld', 11:01:26 INFO - 'LANG': 'en_US.UTF-8', 11:01:26 INFO - 'LANGUAGE': 'en_US:en', 11:01:26 INFO - 'LOGNAME': 'cltbld', 11:01:26 INFO - 'MAIL': '/var/mail/cltbld', 11:01:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:01:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:01:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:01:26 INFO - 'MOZ_NO_REMOTE': '1', 11:01:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:01:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:01:26 INFO - 'NO_EM_RESTART': '1', 11:01:26 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:01:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:01:26 INFO - 'PWD': '/builds/slave/test', 11:01:26 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:01:26 INFO - 'RUST_BACKTRACE': 'full', 11:01:26 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 11:01:26 INFO - 'SHELL': '/bin/bash', 11:01:26 INFO - 'SHLVL': '1', 11:01:26 INFO - 'STYLO_FORCE_ENABLED': '1', 11:01:26 INFO - 'TERM': 'linux', 11:01:26 INFO - 'TMOUT': '86400', 11:01:26 INFO - 'USER': 'cltbld', 11:01:26 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093', 11:01:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:01:26 INFO - '_': '/tools/buildbot/bin/python'} 11:01:26 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 11:01:26 INFO - mozversion application_buildid: 20170820170949 11:01:26 INFO - mozversion application_changeset: cab35526779367774b3ecea2f7a8a5c0993caa77 11:01:26 INFO - mozversion application_display_name: Nightly 11:01:26 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:01:26 INFO - mozversion application_name: Firefox 11:01:26 INFO - mozversion application_remotingname: firefox 11:01:26 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 11:01:26 INFO - mozversion application_vendor: Mozilla 11:01:26 INFO - mozversion application_version: 57.0a1 11:01:26 INFO - mozversion platform_buildid: 20170820170949 11:01:26 INFO - mozversion platform_changeset: cab35526779367774b3ecea2f7a8a5c0993caa77 11:01:26 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 11:01:26 INFO - mozversion platform_version: 57.0a1 11:01:26 INFO - using testdate: 1503252086 11:01:26 INFO - actual date: 1503252086 11:01:26 INFO - starting webserver on 'localhost:53323' 11:01:26 INFO - SUITE-START | Running 2 tests 11:01:26 INFO - TEST-START | dromaeo_css 11:01:26 INFO - Initialising browser for dromaeo_css test... 11:01:27 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:53323/getInfo.html -profile /tmp/tmpf0LxOX/profile 11:01:27 INFO - TEST-INFO | started process 5910 (/builds/slave/test/build/application/firefox/firefox http://localhost:53323/getInfo.html) 11:01:33 INFO - TEST-INFO | 5910: exit 0 11:01:33 INFO - Browser initialized. 11:01:33 INFO - Running cycle 1/1 for dromaeo_css test... 11:01:33 INFO - TEST-INFO | started process 6097 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpf0LxOX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 11:01:34 INFO - PID 6097 | 11:01:34 INFO - PID 6097 | (/builds/slave/test/build/application/firefox/firefox:6146): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 11:01:34 INFO - PID 6097 | 11:01:34 INFO - PID 6097 | 11:01:34 INFO - PID 6097 | (/builds/slave/test/build/application/firefox/firefox:6206): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 11:01:34 INFO - PID 6097 | 11:01:35 INFO - PID 6097 | __metrics Screen width/height:1600/1200 11:01:35 INFO - PID 6097 | colorDepth:24 11:01:35 INFO - PID 6097 | Browser inner width/height: 1024/768 11:01:35 INFO - PID 6097 | __metrics 11:01:44 INFO - PID 6097 | RSS: Main: 174477312 11:01:44 INFO - PID 6097 | 11:04:43 INFO - PID 6097 | Cycle 1(1): loaded http://localhost:53323/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53323/tests/dromaeo/cssquery-ext.html) 11:04:44 INFO - PID 6097 | RSS: Main: 175931392 11:04:44 INFO - PID 6097 | 11:07:46 INFO - PID 6097 | Cycle 1(1): loaded http://localhost:53323/tests/dromaeo/cssquery-ext.html (next: http://localhost:53323/tests/dromaeo/cssquery-jquery.html) 11:07:47 INFO - PID 6097 | RSS: Main: 174817280 11:07:47 INFO - PID 6097 | 11:10:48 INFO - PID 6097 | Cycle 1(1): loaded http://localhost:53323/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53323/tests/dromaeo/cssquery-mootools.html) 11:10:49 INFO - PID 6097 | RSS: Main: 177618944 11:10:49 INFO - PID 6097 | 11:13:51 INFO - PID 6097 | Cycle 1(1): loaded http://localhost:53323/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53323/tests/dromaeo/cssquery-prototype.html) 11:13:52 INFO - PID 6097 | RSS: Main: 175362048 11:13:52 INFO - PID 6097 | 11:16:55 INFO - PID 6097 | Cycle 1(1): loaded http://localhost:53323/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53323/tests/dromaeo/cssquery-yui.html) 11:16:56 INFO - PID 6097 | RSS: Main: 179068928 11:16:56 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | Cycle 1(1): loaded http://localhost:53323/tests/dromaeo/cssquery-yui.html (next: http://localhost:53323/tests/dromaeo/cssquery-dojo.html) 11:19:58 INFO - PID 6097 | RSS: Main: 179490816 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | __start_tp_report 11:19:58 INFO - PID 6097 | _x_x_mozilla_page_load 11:19:58 INFO - PID 6097 | _x_x_mozilla_page_load_details 11:19:58 INFO - PID 6097 | |i|pagename|runs| 11:19:58 INFO - PID 6097 | |0;dojo.html;2995.1014695591343;3105.4254962831865;3161.351922855814;3183.8408079596015;3184.4108839864625;6120.938790612093;6240.563160578761;6270.52971027173;6275.4038366355235;6278.089676996833;5965.492933100681;6068.998615228482;6075.848103797396;6093.299270583884;6135.693215339226;5642.294713160855;5643.887122257553;5644.463775941279;5663.923854467658;5670.914936275959;5683.5169010634145;5692.5161361284345;5724.513416359614;5743.483086522212;5763.942360576403;5669.829905102853;5731.512821410185;5750.971245143768;5769.24999750034;5773.595848290622;5421.783128674848;5509.283793106911;5640.971795140998;5649.209110724501;5685.061964775807;5526;5554.638948468337;5556.361018482886;5587.106063029895;5643.181738647914;6000.069989151645;6015.729292181819;6024.939750602525;6031.939680603182;6135.785247516315;6453.903191452132;6503.479721622259;6567.343265673442;6582.76960306387;6601.3068627794355;6664.100346453215;6667.899981500282;6692.263850976388;6693;6696.229933557605;6172.444479996821;6192.907106393408;6214.720337584774;6217.658028808459;6221.377862213788;6731.966340168267;6738.157730283715;6758.763443279461;6824.7952561423235;6864.107666003388;6410.0705397717065;6437.324080971524;6489.123968264224;6508.60948343101;6530.183727034121;6655.101561289261;6732.091167692397;6742.9662851685425;6772.187337519529;6773.491988100912;6677.165354330708;6738.629375384303;6739.359760822714;6742.8651426972165;6752.189737231563;6630.104935833697;6671.899921501182;6675.632840193836;6749.662516874137;6793.762218322335;5296.973515132399;5333.7866485340155;5335.573154147659;5355.973220133875;5517.779288828402;4575.290829921301;4618.861434156981;4638.420197475316;4652.069586082797;4668.813247470063;5741.425857414309;5761.049426844607;5828.329742079631;5843.970780146072;5848.122781582797;6661.3005634408655;6716.29478904708;6754.6284954327;6776.2546119926765;6808.046873437723;5678.3186017678145;5752.511036561856;5763.366029736726;5777.480026797609;5833.154192642043;5901.675407852609;5919.260092488439;5934.673592952429;5942.3166335871065;5953.226080609493;6331.398517140864;6521.673916304166;6522.902156467657;6526.510511711641;6538.476921846241;6658.001299805068;6661.800145995628;6669.599824010575;6749.696263668048;6762.8985565217545;6363.077353783768;6444.13004244421;6472.126262954441;6495.220573531206;6581.308962559054;6543.901841472477;6579.342065793382;6595.835104122435;6608.966955165193;6610.438112760276;6662.900056499253;6664.400203981665;6685.6322902240845;6713.865722685421;6757.459403247827;6422.3577642235405;6441.742330306923;6455.580387274812;6517.967410163109;6544.54188206821;6428.871422571616;6446.161998940108;6451.870962580629;6454.612723236621;6455.064015717789;6189.226346706661;6393.552451328363;6394.808155755149;6398.744050237939;6410.935890641033;6411.198600174978;6478.6436745977535;6573.1783527059115;6612.570182938093;6661.533692641662;6267.780627678009;6320.115183874169;6347.523935704933;6437.774677886251;6446.226452825691 11:19:58 INFO - PID 6097 | |1;ext.html;774.5120574038355;800.6237068577774;813.99593002035;832.8042909916169;842.2588122452241;41241;41875.371869421986;41926.9518262044;42047.36928946061;42206.7889660552;38721.41917871234;38810.8059459703;38928;38998;39063.21873562534;6862.416694580967;6962.443004559623;6978.476614253926;6992.5105242633035;6995.720171193172;6899.206591241996;7013.4389248860225;7016.087908571904;7020.543664661781;7023.543469674455;7694.076710794685;7852.882206766903;7880.172581878906;7881.487703299296;7893.605319734019;7792.45452818303;7848.529088254666;7852.842943141105;7858.017747781528;7858.09631892334;7562.3950083993695;7668.578228197447;7733.110692270348;7733.96133019337;7758.224177582253;38862.80568597139;38994;39005.8546779927;39055.60944390548;39104.21791564181;3474.322507111114;3513.6135025147214;3532.6467353264725;3536.4341705327024;3543.326767914088;31891.52162717561;31928.20179495508;31986;31992.520112198337;31996.360072798645;5106.004329155816;5175.353080864892;5194.974025129888;5214.791408343662;5217.060929032773;182402;183655;188873.05563472232;191683;231609.9999999983;50497.707694845616;51325.23012154821;51417.228741568906;51456.48543514592;51513.484865151615;54709;54765.452345476835;54779;54815.72592137014;55201.72399137979;16983.065931373894;17039.659206815795;17064.744028839577;17147.657046858993;17164.742528862076;14046.578602641937;14091.78862317066;14099.083559568595;14108.365123569463;14206.502772403122;15002.549923502313;15042.849571504365;15144.242787860783;15229.771553426708;15258.542243732705;5972.970135149297;6116.724747386378;6184.752609895554;6200.100985357098;6229.719662615194;1022.3559157730582;1022.6880801355509;1026.2303272545591;1038.0864838941684;1040.1003132290514;23035.654465183037;23445.296641100795;28611.57082643762;28706.425871482872;29358.853205733834;1101.0420933787657;1104.7293413113678;1111.5887121765;1111.7387413957713;1118.3010618363523;12407.379631018413;12488.144798186868;12492.562760303346;12548.623541293593;12550.623481295575;231157;231405;231836;232273;233936;51519.48480515222;52028.47971520236;52201;52220.73889630527;52281.73859130756;1475.8229012518352;1485.7548504496638;1503.3760989189363;1513.0392200952253;1518.2484670088156;22304.330870073274;22374.328770136923;22612.547749045258;22748.658770118793;22846.086156554218;37637.2472550542;37638.24723505569;37790;37926.24147517089;37991.81004094962;196442;196671;196867;197003;197022;30900.381992360475;31329.843350784013;31341.52987705232;32983.17542061468;34048.48927266044;41143.7942810284;41218.79390603028;41240.58759412367;41584.58415415928;41934.580654193065;28428;29257.85371073131;34421.655783442846;35716.64283357237;35900.64099358973;34862.9541113767;35018.474722878665;35071.47392789059;35073.1231719209;35841.46237806383;37356;37477;37619.62380376161;37762;37811.62188378191;32989.17527061843;33072.1731956703;33189.50215746814;33280.334393312485;33732.66267337393;23633.52732945366;24065.619901510752;24229.273121806375;24290.87854560716;24360 11:19:58 INFO - PID 6097 | |2;jquery.html;572.3303734630482;574.8246784730658;579.4611011759063;584.1121495327101;597.4921316880651;22691.20580779673;23018.07927682895;23682.407939801513;23748.64377034344;23764;26776.464470710573;27049;27291;27311.317217069583;27339.72660273397;6323.77866774663;6481.254655714582;6486.189226346707;6487.643179625119;6490.870182596345;6298.622082675054;6502.2197336319705;6526.869462610745;6551.705173267214;6604.933950660504;6556.541042127029;6558.409743123118;6562.376574225441;6579.374959378852;6592.472602191837;6593.044008618747;6595.208574971034;6595.53831231814;6596.406323430891;6601.14185155929;6080.209572755513;6092.147099406086;6122.479589234876;6128.693565321761;6130;29802.403951921056;30624.846875765703;30928.226794330098;31250.374992500023;31430.214244643837;1946.5717542140706;1980.564275859323;1989.8109679580416;1990.3531352310413;1995.2019192323041;19456;20005.49986250341;20305.898470507702;20352.084156213004;20479.89760051205;2236.865788052722;2250.4936389312275;2272.125231785758;2289.8511596746325;2343.9531209375887;140376;146528;146587;147105.26447367802;147228;14722.926385368219;15027.624309392353;15165.317560709795;15175;15518.448155184617;23825.40436489067;23918.52162956766;23924.401889952544;24016.27951161468;24030;10282.177425805918;10330.638427655147;10594.841077383846;10698;10706.197035222389;9567.091126342986;9642.373245739005;9664.130228279488;9665.565049572646;9864.112229899343;9152.725418237464;9398.248140148771;9543.379680320757;9570.665026724171;9779.168770654433;2672.3185587675407;2721.9319517011836;2749.0790585154195;2756.145594865598;2808.971910280871;948.2224575847739;965.5944503308627;972.4651441707033;992.8659630949729;1002.3284399452384;20508;21063.26278580273;21325.68011479829;21378.89310553437;21643.67534486984;1037.9896201037893;1045.5347370420243;1051.3218973762034;1057.4184198690843;1058.0794708603564;11516.769664606662;11534.769304613861;11580.594679186188;11583.6524904253;11603.883961160449;520419;524777;532907;534032;536217;120362.3981880085;128101.35949320193;128989.35505322414;129981;130789.34605327103;1081.3511892864376;1126.7126882644873;1199.9460024298928;1205.7046023724245;1262.8421447319085;21883.562328753018;22000.229991950204;22434.214802481834;22517.887410562842;22610.321690349316;62524.374756253674;63243.683781580796;63681.68159159175;64032.67983660052;64621;75748.62125689557;75914.24085759293;76753.61623191848;76869.61565192362;77221.61389193017;20877.58244835125;21472.355829325144;21662.8916855421;21750.78249217551;21922.013509392436;23246;23982.52034959256;24483.51032979295;24677.62983555212;24692.629610556214;17806.46580602532;18157.45527634173;18343.26626934908;18392.816071839112;18412.723809142604;17156.571085722957;17273.91363043227;17681.823181768017;17892.642147157243;18213.362532311305;19414.417567473;19435;19580.11889464949;19630.116644751306;19734.802651973296;21263.149474021484;21335.933203340082;21373.89313053425;21466.463338416663;21495.892520537298;18571.350002749838;18767.53081172927;19255.422337329903;19285.42143735634;19334.419967401 11:19:58 INFO - PID 6097 | |3;mootools.html;1362.3664995776962;1402.9368678409471;1419.6379923119596;1421.9573412797606;1424.4871846135393;14445.422183112676;14704.926475367609;15020.248987550633;15124.470643527478;15143.242837858104;15207.84792152078;15449.613759656015;15465.690686186297;15472.381104755825;15507.68984620307;2728.6998430172666;2771.390294135297;2773.500769861424;2776.3891943772437;2780.819246748955;2616.9738302617016;2713.050432348672;2815.521361368562;2822.139247529503;2822.4355128974184;2730.481208570365;2743.245607457945;2757.9586306205424;2758.2276962450446;2762.9447411051765;2693.4478431921407;2715.416185520123;2730.781537476997;2742.478929003483;2755.2147637923194;2673.9331516712045;2703.189043287006;2712.4846279207086;2722.8774705138117;2726.5364887969095;14594.416223351052;14619.92690036543;14641.780373294408;14643;14728.410863565445;7586.241375862425;7712.421568382338;7964.203579642048;8022.9598852005365;8044.436889417743;5226.895462090775;5343.091674415358;5436.374816896068;5480.3971563128025;5495.972520137374;1818.7999320074782;1838;1869.12151288894;1907.1513176636402;1907.4659095453296;24696.753032469624;24871.378215544755;24881.875590622112;24883.875580622163;24895.50208995828;6660.333966603398;6980.441564674814;7046.9078998674495;7263;7266.128064632172;16568.6686266274;16698.916505417637;16759.2458339375;16779.748303775454;16786.4124755633;7736.7292144774665;7863.764087077397;7866.056073271244;7869.803254918673;7874.488158269694;6288.591241569284;7154.248803875622;7215.098112735908;7263.527870688388;7348.412127029825;4766.118268120409;5282.841514754564;5292.259083728281;5413.48422441717;5413.512783849473;1521.5815650696147;1534.7645145657852;1540.5070377479324;1544.9845501544842;1558.4934896158793;878.7451639024739;894.4320356573622;904.5590771509376;913.5340976102236;914.8673442350822;8069.0317161939765;8602.827943441096;8616.827663446697;8681.435706679045;8720.476771393736;977.7995510920387;998.4259051045533;1015.243643485608;1015.5477666936351;1021.1371391174446;5343.973280133574;5348.759305831247;5578.2748242728185;5599.132134519156;5674.77300907959;20131.19475221004;20296.28962986318;21089.894550527457;21130.049147788388;21131.471713206985;20004.799952000583;20555.8972205138;20649.896750516153;20727.067281972348;21010.36968890936;11033.724156896142;11089.667309980714;11216.327020378803;11330.263532870336;11392.25950313227;8177.141400152898;8296.917030829856;8445.324374050184;8498.91501085006;8537.914620853711;17304.394346197823;17876.821231788035;17943.820561794215;18332.816671833112;18681.346152884584;17717.29130834752;17722;17779.11104444747;17864;17955.910220448815;11990.220635658654;12063.879361206276;12138.211016284267;12214.633560993185;12217.816732749194;13569.1858488491;13693.383797728928;13723.656908577366;13745.656358591115;13772.311384430537;10785.568577256821;10977.066949309397;11188.720281993015;11236.494357753758;11257.49341279628;10310.278280520592;10325.328853624791;10373.533191006272;10419.322744021614;10536.57853685844;9603.135717785433;9757.853632195382;9819.116279534876;9820.803583928424;9824.950875245579;7426.14599321085;7464.253574642492;7524.247575242651;7547.849043019219;7633.770986870402;7470.365018973231;7537.510061845963;7564.205758395509;7628.54228746277;7746.264104910025 11:19:58 INFO - PID 6097 | |4;prototype.html;502.3532567610407;515.889083846973;523.861176788151;526.3657292961981;535.7696190638025;6127.601705889119;6196.566240363165;6236.750529978806;6239.6880155992185;6330.177076979992;6078.270607527092;6099.603525770822;6161.969190154043;6191.876162476748;6240.968795156018;5166.328377310944;5173.534381905628;5194.142966410556;5198.324217851693;5198.870028249286;4812.398450193726;5069.997351046334;5121.641485096045;5125.564327032188;5151.639385243035;4864.124457597631;4866.878328041792;4911.607071434277;4930.161872481687;4964.032013757319;4820.373351464323;4907.656464047518;4960.23116416956;4970.925436118425;4983.551480366748;4339.7830108494445;4398.274284743014;4416.003516817285;4459.509453960061;4489.59593636571;5930.436608522226;5984.700764961734;5989.790357337516;6006.609570377911;6033.788817391414;5650.7790559381165;5708.857278568027;5718.59969802114;5720.170575266605;5723.885522289531;6491.285958544557;6511.316311787242;6518.93481065188;6528.771492997722;6535.313792051814;4819.2530157825595;4832.855014349575;4856.902861942742;4910.975445122787;4918.311436398907;6495.837604059936;6654.735600235939;6668.466522678223;6762.898556521656;6901.102856628606;4972.776225069881;4989.706793516334;5000.449950505442;5049.394072711299;5064.974675126675;5051.924221136685;5069.138246498104;5083.415407228216;5093.668911520739;5104.3364362633365;5685.3177618685195;5686.402927692616;5686.60193786431;5696.743646535916;5702.657840529581;6592.044153597702;6641.203055633258;6646.86706265872;6668.699908504129;6681.465482761368;1762.1629725880105;1767.1605987156;1768.2043080613776;1771.9291228350721;1784.2327799046534;1161.6573110932295;1203.9699007524882;1213.5327898758865;1221.6274036418977;1230.1634888276058;5802.854928626733;5810.709464526757;5835.94164058354;5838.7446698959075;5871.823845284648;6719.664016799141;6729.4279986200745;6739.629320387426;6752.5948443093575;6795.150606174228;5641.830745077655;5693.206639908416;5711.400302968212;5740.397258287903;5749.498967948955;3513.4378499439968;3533.9293214135573;3564.9643503564635;3572.982135089308;3574.696150827157;6453.483721302285;6479.902801457982;6498.902516462257;6499.642519661464;6560.868782624416;6787.592744435251;6835.726570937206;6847.863042739217;6855.01806714081;6918.135233095863;6395.488360931115;6430.164078669836;6446.580972236789;6516.090345792487;6522.28254891952;6659.467242620482;6669.766558170635;6680.465562754871;6719.529632925648;6801.965990170215;6067.54493412987;6481.4814814815645;6502.317256687979;6648.301928297459;6732.528722989539;6297.433231009231;6308.432241098323;6352.968235158794;6367.810234658738;6538.901916471352;4856.562909338177;4947.703137811743;4989.226669866177;5009.073321435546;5040.974795126148;6368.306382298163;6508.479321654161;6547.544670748469;6704.497162712719;6787.185537735503;6356.173697419306;6399.872002560016;6445.742170313135;6543.550385737744;6577.671116444254;6349.428551430394;6352.2531303889955;6432.35676432353;6459.801129266015;6573.57271777333;6338.8732225354315;6382.936170638234;6393.360663933569;6423.614583125028;6490.592438969578;6466.935330646634;6557.868842623217;6589.7364105435245;6644.136262285871;6697.665116744241;6313.494920406449;6340.682965851781;6342.651154186379;6399.6800159992745;6428.839279018062 11:19:58 INFO - PID 6097 | |5;yui.html;897.9191872731457;917.2066162769206;920.167248639981;929.2565947242205;934.8410770169071;19099.42701718949;20165.798342016576;20204;20218.797812021876;21887.890560547174;21730.674039889414;22414.439639008993;22414.88792556035;22415;22422.215222467217;994.6021591363458;1013.0679774607379;1015.7308313296983;1016.0296916444814;1017.6489111256604;1027.0653705128334;1062.2351906627255;1065.8188108021616;1065.9413732244723;1081.7025318037563;1097.7639807441399;1099.6426161497504;1100.1528822806433;1100.2848148703326;1108.4790148630132;1096.627146770098;1096.802575536403;1096.9396683182422;1098.4343063322356;1106.88377720339;804.0431886055575;804.3324041045977;804.5132694719669;804.5936801915054;809.7085049382217;19450;19594.412167634993;19923.20307187725;20026.1989520419;20061.899690501454;21187.5762484751;21197.152113915425;21607.1357145714;21782.564348713095;21789.673154902688;17156.571085722957;17158.39945601898;17354.826451735447;17379.913100434544;17550.912245438692;3678.981605091984;3704;3705.314516814398;3710.07248187953;3712.554493460775;126595;126658.3667081668;127086;130568;133474;16554.668906622042;16572.917135414245;16689.332426702797;16901.577460563338;16970.490885273462;30686.69313306883;31279.84360078185;31302.06093817189;32657.673423265463;32799.50800737991;7947.761567152995;8316.750497485085;8757.605907734167;8827.073157318517;9154.038825923315;4405.493368262627;4455.1980643484485;4463.642908567307;4463.866084017484;4497.033137875373;5254.842354729364;5333.093374126408;5377.623566350318;5389.218563308376;5418.431064738224;1099.6536091131268;1107.7175320293275;1124.9887501125047;1128.8532490776147;1129.1136457880525;695.1484431571284;706.586646811621;708.3919502728879;710.4068103133837;722.1767185408638;10361.378317300987;10902.781944361068;11045.226834121535;11339.319640821577;12903.612891613267;705.8376573388149;706.7067167125585;709.6806437103221;717.9569225846466;718.7807718645759;5347.144456886879;5469.726513674301;5514.6139770216505;5634.661920284796;5685.516731077904;108130;110057.44971275092;111192;112724;115555;93357;95051.52474237722;95594;95640;96493;85921;86930.56534717286;87255;90932;91244.54377728069;10333.173346132442;10421.531031103466;10448.268621196443;10676.359418434919;10709.732256693645;39096.41355379728;39869.00327491836;40333.39499907445;40631.593684062784;40933;54444;67858;70794;74147.62926185335;75895.24104758882;17235.827641723423;19757.802421976172;19946;20056.799432006075;20136.093875775332;21443.892780536622;21556.67664985058;22102.88948555247;22116.557668846854;22256.554868902855;17573.472795816146;17659.38192163268;17889.19498622539;18027.639447211244;18045.909770451588;17260.309587616353;17278.308867645657;17731.734023989393;18336.81663183351;18525.90737046306;16722.331106755595;16867;16993.32026718967;17082.316707331567;17164.82835171632;12236.082293828176;12647.177933434297;12702.047346448868;12728.363581821057;12754.42605082755;12583;12752.553660621834;12776.74446511083;12810.55163069288;13064.869351306745 11:19:58 INFO - PID 6097 | __end_tp_report 11:19:58 INFO - PID 6097 | __start_cc_report 11:19:58 INFO - PID 6097 | _x_x_mozilla_cycle_collect,397 11:19:58 INFO - PID 6097 | __end_cc_report 11:19:58 INFO - PID 6097 | __startTimestamp1503253198366__endTimestamp 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | ------- Summary: start ------- 11:19:58 INFO - PID 6097 | Number of tests: 6 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | [#0] dojo.html Cycles:165 Average:6120.37 Median:6394.81 stddev:729.76 (11.4%) stddev-sans-first:689.59 11:19:58 INFO - PID 6097 | Values: 2995.1 3105.4 3161.4 3183.8 3184.4 6120.9 6240.6 6270.5 6275.4 6278.1 5965.5 6069.0 6075.8 6093.3 6135.7 5642.3 5643.9 5644.5 5663.9 5670.9 5683.5 5692.5 5724.5 5743.5 5763.9 5669.8 5731.5 5751.0 5769.2 5773.6 5421.8 5509.3 5641.0 5649.2 5685.1 5526.0 5554.6 5556.4 5587.1 5643.2 6000.1 6015.7 6024.9 6031.9 6135.8 6453.9 6503.5 6567.3 6582.8 6601.3 6664.1 6667.9 6692.3 6693.0 6696.2 6172.4 6192.9 6214.7 6217.7 6221.4 6732.0 6738.2 6758.8 6824.8 6864.1 6410.1 6437.3 6489.1 6508.6 6530.2 6655.1 6732.1 6743.0 6772.2 6773.5 6677.2 6738.6 6739.4 6742.9 6752.2 6630.1 6671.9 6675.6 6749.7 6793.8 5297.0 5333.8 5335.6 5356.0 5517.8 4575.3 4618.9 4638.4 4652.1 4668.8 5741.4 5761.0 5828.3 5844.0 5848.1 6661.3 6716.3 6754.6 6776.3 6808.0 5678.3 5752.5 5763.4 5777.5 5833.2 5901.7 5919.3 5934.7 5942.3 5953.2 6331.4 6521.7 6522.9 6526.5 6538.5 6658.0 6661.8 6669.6 6749.7 6762.9 6363.1 6444.1 6472.1 6495.2 6581.3 6543.9 6579.3 6595.8 6609.0 6610.4 6662.9 6664.4 6685.6 6713.9 6757.5 6422.4 6441.7 6455.6 6518.0 6544.5 6428.9 6446.2 6451.9 6454.6 6455.1 6189.2 6393.6 6394.8 6398.7 6410.9 6411.2 6478.6 6573.2 6612.6 6661.5 6267.8 6320.1 6347.5 6437.8 6446.2 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | [#1] ext.html Cycles:180 Average:38147.99 Median:3539.88 stddev:54169.92 (1530.3%) stddev-sans-first:54249.19 11:19:58 INFO - PID 6097 | Values: 774.5 800.6 814.0 832.8 842.3 41241.0 41875.4 41927.0 42047.4 42206.8 38721.4 38810.8 38928.0 38998.0 39063.2 6862.4 6962.4 6978.5 6992.5 6995.7 6899.2 7013.4 7016.1 7020.5 7023.5 7694.1 7852.9 7880.2 7881.5 7893.6 7792.5 7848.5 7852.8 7858.0 7858.1 7562.4 7668.6 7733.1 7734.0 7758.2 38862.8 38994.0 39005.9 39055.6 39104.2 3474.3 3513.6 3532.6 3536.4 3543.3 31891.5 31928.2 31986.0 31992.5 31996.4 5106.0 5175.4 5195.0 5214.8 5217.1 182402.0 183655.0 188873.1 191683.0 231610.0 50497.7 51325.2 51417.2 51456.5 51513.5 54709.0 54765.5 54779.0 54815.7 55201.7 16983.1 17039.7 17064.7 17147.7 17164.7 14046.6 14091.8 14099.1 14108.4 14206.5 15002.5 15042.8 15144.2 15229.8 15258.5 5973.0 6116.7 6184.8 6200.1 6229.7 1022.4 1022.7 1026.2 1038.1 1040.1 23035.7 23445.3 28611.6 28706.4 29358.9 1101.0 1104.7 1111.6 1111.7 1118.3 12407.4 12488.1 12492.6 12548.6 12550.6 231157.0 231405.0 231836.0 232273.0 233936.0 51519.5 52028.5 52201.0 52220.7 52281.7 1475.8 1485.8 1503.4 1513.0 1518.2 22304.3 22374.3 22612.5 22748.7 22846.1 37637.2 37638.2 37790.0 37926.2 37991.8 196442.0 196671.0 196867.0 197003.0 197022.0 30900.4 31329.8 31341.5 32983.2 34048.5 41143.8 41218.8 41240.6 41584.6 41934.6 28428.0 29257.9 34421.7 35716.6 35900.6 34863.0 35018.5 35071.5 35073.1 35841.5 37356.0 37477.0 37619.6 37762.0 37811.6 32989.2 33072.2 33189.5 33280.3 33732.7 23633.5 24065.6 24229.3 24290.9 24360.0 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | [#2] jquery.html Cycles:180 Average:37579.94 Median:12653.97 stddev:89237.94 (705.2%) stddev-sans-first:89445.02 11:19:58 INFO - PID 6097 | Values: 572.3 574.8 579.5 584.1 597.5 22691.2 23018.1 23682.4 23748.6 23764.0 26776.5 27049.0 27291.0 27311.3 27339.7 6323.8 6481.3 6486.2 6487.6 6490.9 6298.6 6502.2 6526.9 6551.7 6604.9 6556.5 6558.4 6562.4 6579.4 6592.5 6593.0 6595.2 6595.5 6596.4 6601.1 6080.2 6092.1 6122.5 6128.7 6130.0 29802.4 30624.8 30928.2 31250.4 31430.2 1946.6 1980.6 1989.8 1990.4 1995.2 19456.0 20005.5 20305.9 20352.1 20479.9 2236.9 2250.5 2272.1 2289.9 2344.0 140376.0 146528.0 146587.0 147105.3 147228.0 14722.9 15027.6 15165.3 15175.0 15518.4 23825.4 23918.5 23924.4 24016.3 24030.0 10282.2 10330.6 10594.8 10698.0 10706.2 9567.1 9642.4 9664.1 9665.6 9864.1 9152.7 9398.2 9543.4 9570.7 9779.2 2672.3 2721.9 2749.1 2756.1 2809.0 948.2 965.6 972.5 992.9 1002.3 20508.0 21063.3 21325.7 21378.9 21643.7 1038.0 1045.5 1051.3 1057.4 1058.1 11516.8 11534.8 11580.6 11583.7 11603.9 520419.0 524777.0 532907.0 534032.0 536217.0 120362.4 128101.4 128989.4 129981.0 130789.3 1081.4 1126.7 1199.9 1205.7 1262.8 21883.6 22000.2 22434.2 22517.9 22610.3 62524.4 63243.7 63681.7 64032.7 64621.0 75748.6 75914.2 76753.6 76869.6 77221.6 20877.6 21472.4 21662.9 21750.8 21922.0 23246.0 23982.5 24483.5 24677.6 24692.6 17806.5 18157.5 18343.3 18392.8 18412.7 17156.6 17273.9 17681.8 17892.6 18213.4 19414.4 19435.0 19580.1 19630.1 19734.8 21263.1 21335.9 21373.9 21466.5 21495.9 18571.4 18767.5 19255.4 19285.4 19334.4 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | [#3] mootools.html Cycles:180 Average:9177.74 Median:2698.32 stddev:6336.74 (234.8%) stddev-sans-first:6327.31 11:19:58 INFO - PID 6097 | Values: 1362.4 1402.9 1419.6 1422.0 1424.5 14445.4 14704.9 15020.2 15124.5 15143.2 15207.8 15449.6 15465.7 15472.4 15507.7 2728.7 2771.4 2773.5 2776.4 2780.8 2617.0 2713.1 2815.5 2822.1 2822.4 2730.5 2743.2 2758.0 2758.2 2762.9 2693.4 2715.4 2730.8 2742.5 2755.2 2673.9 2703.2 2712.5 2722.9 2726.5 14594.4 14619.9 14641.8 14643.0 14728.4 7586.2 7712.4 7964.2 8023.0 8044.4 5226.9 5343.1 5436.4 5480.4 5496.0 1818.8 1838.0 1869.1 1907.2 1907.5 24696.8 24871.4 24881.9 24883.9 24895.5 6660.3 6980.4 7046.9 7263.0 7266.1 16568.7 16698.9 16759.2 16779.7 16786.4 7736.7 7863.8 7866.1 7869.8 7874.5 6288.6 7154.2 7215.1 7263.5 7348.4 4766.1 5282.8 5292.3 5413.5 5413.5 1521.6 1534.8 1540.5 1545.0 1558.5 878.7 894.4 904.6 913.5 914.9 8069.0 8602.8 8616.8 8681.4 8720.5 977.8 998.4 1015.2 1015.5 1021.1 5344.0 5348.8 5578.3 5599.1 5674.8 20131.2 20296.3 21089.9 21130.0 21131.5 20004.8 20555.9 20649.9 20727.1 21010.4 11033.7 11089.7 11216.3 11330.3 11392.3 8177.1 8296.9 8445.3 8498.9 8537.9 17304.4 17876.8 17943.8 18332.8 18681.3 17717.3 17722.0 17779.1 17864.0 17955.9 11990.2 12063.9 12138.2 12214.6 12217.8 13569.2 13693.4 13723.7 13745.7 13772.3 10785.6 10977.1 11188.7 11236.5 11257.5 10310.3 10325.3 10373.5 10419.3 10536.6 9603.1 9757.9 9819.1 9820.8 9825.0 7426.1 7464.3 7524.2 7547.8 7633.8 7470.4 7537.5 7564.2 7628.5 7746.3 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | [#4] prototype.html Cycles:180 Average:5489.22 Median:6072.91 stddev:1529.65 (25.2%) stddev-sans-first:1487.44 11:19:58 INFO - PID 6097 | Values: 502.4 515.9 523.9 526.4 535.8 6127.6 6196.6 6236.8 6239.7 6330.2 6078.3 6099.6 6162.0 6191.9 6241.0 5166.3 5173.5 5194.1 5198.3 5198.9 4812.4 5070.0 5121.6 5125.6 5151.6 4864.1 4866.9 4911.6 4930.2 4964.0 4820.4 4907.7 4960.2 4970.9 4983.6 4339.8 4398.3 4416.0 4459.5 4489.6 5930.4 5984.7 5989.8 6006.6 6033.8 5650.8 5708.9 5718.6 5720.2 5723.9 6491.3 6511.3 6518.9 6528.8 6535.3 4819.3 4832.9 4856.9 4911.0 4918.3 6495.8 6654.7 6668.5 6762.9 6901.1 4972.8 4989.7 5000.4 5049.4 5065.0 5051.9 5069.1 5083.4 5093.7 5104.3 5685.3 5686.4 5686.6 5696.7 5702.7 6592.0 6641.2 6646.9 6668.7 6681.5 1762.2 1767.2 1768.2 1771.9 1784.2 1161.7 1204.0 1213.5 1221.6 1230.2 5802.9 5810.7 5835.9 5838.7 5871.8 6719.7 6729.4 6739.6 6752.6 6795.2 5641.8 5693.2 5711.4 5740.4 5749.5 3513.4 3533.9 3565.0 3573.0 3574.7 6453.5 6479.9 6498.9 6499.6 6560.9 6787.6 6835.7 6847.9 6855.0 6918.1 6395.5 6430.2 6446.6 6516.1 6522.3 6659.5 6669.8 6680.5 6719.5 6802.0 6067.5 6481.5 6502.3 6648.3 6732.5 6297.4 6308.4 6353.0 6367.8 6538.9 4856.6 4947.7 4989.2 5009.1 5041.0 6368.3 6508.5 6547.5 6704.5 6787.2 6356.2 6399.9 6445.7 6543.6 6577.7 6349.4 6352.3 6432.4 6459.8 6573.6 6338.9 6382.9 6393.4 6423.6 6490.6 6466.9 6557.9 6589.7 6644.1 6697.7 6313.5 6340.7 6342.7 6399.7 6428.8 11:19:58 INFO - PID 6097 | 11:19:58 INFO - PID 6097 | [#5] yui.html Cycles:180 Average:23888.55 Median:20184.90 stddev:32439.41 (160.7%) stddev-sans-first:32484.47 11:19:58 INFO - PID 6097 | Values: 897.9 917.2 920.2 929.3 934.8 19099.4 20165.8 20204.0 20218.8 21887.9 21730.7 22414.4 22414.9 22415.0 22422.2 994.6 1013.1 1015.7 1016.0 1017.6 1027.1 1062.2 1065.8 1065.9 1081.7 1097.8 1099.6 1100.2 1100.3 1108.5 1096.6 1096.8 1096.9 1098.4 1106.9 804.0 804.3 804.5 804.6 809.7 19450.0 19594.4 19923.2 20026.2 20061.9 21187.6 21197.2 21607.1 21782.6 21789.7 17156.6 17158.4 17354.8 17379.9 17550.9 3679.0 3704.0 3705.3 3710.1 3712.6 126595.0 126658.4 127086.0 130568.0 133474.0 16554.7 16572.9 16689.3 16901.6 16970.5 30686.7 31279.8 31302.1 32657.7 32799.5 7947.8 8316.8 8757.6 8827.1 9154.0 4405.5 4455.2 4463.6 4463.9 4497.0 5254.8 5333.1 5377.6 5389.2 5418.4 1099.7 1107.7 1125.0 1128.9 1129.1 695.1 706.6 708.4 710.4 722.2 10361.4 10902.8 11045.2 11339.3 12903.6 705.8 706.7 709.7 718.0 718.8 5347.1 5469.7 5514.6 5634.7 5685.5 108130.0 110057.4 111192.0 112724.0 115555.0 93357.0 95051.5 95594.0 95640.0 96493.0 85921.0 86930.6 87255.0 90932.0 91244.5 10333.2 10421.5 10448.3 10676.4 10709.7 39096.4 39869.0 40333.4 40631.6 40933.0 54444.0 67858.0 70794.0 74147.6 75895.2 17235.8 19757.8 19946.0 20056.8 20136.1 21443.9 21556.7 22102.9 22116.6 22256.6 17573.5 17659.4 17889.2 18027.6 18045.9 17260.3 17278.3 17731.7 18336.8 18525.9 16722.3 16867.0 16993.3 17082.3 17164.8 12236.1 12647.2 12702.0 12728.4 12754.4 12583.0 12752.6 12776.7 12810.6 13064.9 11:19:58 INFO - PID 6097 | -------- Summary: end -------- 11:19:58 INFO - PID 6097 | 11:19:59 INFO - TEST-INFO | 6097: exit 0 11:19:59 INFO - TEST-OK | dromaeo_css | took 1112143ms 11:19:59 INFO - TEST-START | kraken 11:19:59 INFO - Initialising browser for kraken test... 11:19:59 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:53323/getInfo.html -profile /tmp/tmpa0HEgG/profile 11:19:59 INFO - TEST-INFO | started process 6515 (/builds/slave/test/build/application/firefox/firefox http://localhost:53323/getInfo.html) 11:20:04 INFO - TEST-INFO | 6515: exit 0 11:20:05 INFO - Browser initialized. 11:20:05 INFO - Running cycle 1/1 for kraken test... 11:20:05 INFO - TEST-INFO | started process 6699 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpa0HEgG/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 11:20:06 INFO - PID 6699 | 11:20:06 INFO - PID 6699 | (/builds/slave/test/build/application/firefox/firefox:6748): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 11:20:06 INFO - PID 6699 | 11:20:06 INFO - PID 6699 | 11:20:06 INFO - PID 6699 | (/builds/slave/test/build/application/firefox/firefox:6809): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 11:20:06 INFO - PID 6699 | 11:20:06 INFO - PID 6699 | __metrics Screen width/height:1600/1200 11:20:06 INFO - PID 6699 | colorDepth:24 11:20:06 INFO - PID 6699 | Browser inner width/height: 1024/768 11:20:06 INFO - PID 6699 | __metrics 11:20:16 INFO - PID 6699 | RSS: Main: 174555136 11:20:16 INFO - PID 6699 | 11:20:18 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53323/tests/kraken/driver.html?testName=audio-beat-detection) 11:20:19 INFO - PID 6699 | RSS: Main: 178683904 11:20:19 INFO - PID 6699 | 11:20:22 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53323/tests/kraken/driver.html?testName=audio-dft) 11:20:23 INFO - PID 6699 | RSS: Main: 181149696 11:20:23 INFO - PID 6699 | 11:20:26 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53323/tests/kraken/driver.html?testName=audio-fft) 11:20:26 INFO - PID 6699 | RSS: Main: 175456256 11:20:26 INFO - PID 6699 | 11:20:29 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53323/tests/kraken/driver.html?testName=audio-oscillator) 11:20:29 INFO - PID 6699 | RSS: Main: 175792128 11:20:29 INFO - PID 6699 | 11:20:32 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53323/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:20:32 INFO - PID 6699 | RSS: Main: 175828992 11:20:32 INFO - PID 6699 | 11:20:35 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53323/tests/kraken/driver.html?testName=imaging-darkroom) 11:20:36 INFO - PID 6699 | RSS: Main: 176398336 11:20:36 INFO - PID 6699 | 11:20:39 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53323/tests/kraken/driver.html?testName=imaging-desaturate) 11:20:40 INFO - PID 6699 | RSS: Main: 176484352 11:20:40 INFO - PID 6699 | 11:20:43 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53323/tests/kraken/driver.html?testName=json-parse-financial) 11:20:44 INFO - PID 6699 | RSS: Main: 177532928 11:20:44 INFO - PID 6699 | 11:20:45 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53323/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:20:46 INFO - PID 6699 | RSS: Main: 177037312 11:20:46 INFO - PID 6699 | 11:20:48 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:20:48 INFO - PID 6699 | RSS: Main: 177332224 11:20:48 INFO - PID 6699 | 11:20:51 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:20:51 INFO - PID 6699 | RSS: Main: 177709056 11:20:51 INFO - PID 6699 | 11:20:54 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:20:55 INFO - PID 6699 | RSS: Main: 177201152 11:20:55 INFO - PID 6699 | 11:20:58 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:20:58 INFO - PID 6699 | RSS: Main: 177532928 11:20:58 INFO - PID 6699 | 11:21:00 INFO - PID 6699 | Cycle 1(1): loaded http://localhost:53323/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53323/tests/kraken/driver.html?testName=ai-astar) 11:21:01 INFO - PID 6699 | RSS: Main: 179142656 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | __start_tp_report 11:21:01 INFO - PID 6699 | _x_x_mozilla_page_load 11:21:01 INFO - PID 6699 | _x_x_mozilla_page_load_details 11:21:01 INFO - PID 6699 | |i|pagename|runs| 11:21:01 INFO - PID 6699 | |0;ai-astar;106;108;100;107;108;110;113;100;110;110 11:21:01 INFO - PID 6699 | |1;audio-beat-detection;148;121;145;178;117;147;149;117;173;118 11:21:01 INFO - PID 6699 | |2;audio-dft;165;162;164;163;164;163;166;170;168;164 11:21:01 INFO - PID 6699 | |3;audio-fft;76;86;74;182;74;83;75;76;153;76 11:21:01 INFO - PID 6699 | |4;audio-oscillator;81;82;132;79;79;78;129;79;79;134 11:21:01 INFO - PID 6699 | |5;imaging-gaussian-blur;115;114;114;113;115;115;117;116;114;116 11:21:01 INFO - PID 6699 | |6;imaging-darkroom;151;152;151;152;151;150;153;150;148;149 11:21:01 INFO - PID 6699 | |7;imaging-desaturate;94;93;94;93;94;94;94;95;96;96 11:21:01 INFO - PID 6699 | |8;json-parse-financial;63;55;54;60;55;58;57;59;56;55 11:21:01 INFO - PID 6699 | |9;json-stringify-tinderbox;57;55;55;61;59;59;55;55;55;55 11:21:01 INFO - PID 6699 | |10;stanford-crypto-aes;74;76;75;74;75;76;80;81;81;75 11:21:01 INFO - PID 6699 | |11;stanford-crypto-ccm;135;137;122;127;124;130;120;125;131;161 11:21:01 INFO - PID 6699 | |12;stanford-crypto-pbkdf2;171;185;189;172;174;170;175;172;180;179 11:21:01 INFO - PID 6699 | |13;stanford-crypto-sha256-iterative;71;70;70;72;72;77;74;69;66;67 11:21:01 INFO - PID 6699 | __end_tp_report 11:21:01 INFO - PID 6699 | __start_cc_report 11:21:01 INFO - PID 6699 | _x_x_mozilla_cycle_collect,949 11:21:01 INFO - PID 6699 | __end_cc_report 11:21:01 INFO - PID 6699 | __startTimestamp1503253261001__endTimestamp 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | ------- Summary: start ------- 11:21:01 INFO - PID 6699 | Number of tests: 14 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#0] ai-astar Cycles:10 Average:107.20 Median:109.00 stddev:4.26 (3.9%) stddev-sans-first:4.50 11:21:01 INFO - PID 6699 | Values: 106.0 108.0 100.0 107.0 108.0 110.0 113.0 100.0 110.0 110.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#1] audio-beat-detection Cycles:10 Average:141.30 Median:147.50 stddev:22.70 (15.4%) stddev-sans-first:23.95 11:21:01 INFO - PID 6699 | Values: 148.0 121.0 145.0 178.0 117.0 147.0 149.0 117.0 173.0 118.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#2] audio-dft Cycles:10 Average:164.90 Median:164.50 stddev:2.47 (1.5%) stddev-sans-first:2.62 11:21:01 INFO - PID 6699 | Values: 165.0 162.0 164.0 163.0 164.0 163.0 166.0 170.0 168.0 164.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#3] audio-fft Cycles:10 Average:95.50 Median:76.00 stddev:38.76 (51.0%) stddev-sans-first:40.46 11:21:01 INFO - PID 6699 | Values: 76.0 86.0 74.0 182.0 74.0 83.0 75.0 76.0 153.0 76.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#4] audio-oscillator Cycles:10 Average:95.20 Median:79.00 stddev:25.22 (31.9%) stddev-sans-first:26.22 11:21:01 INFO - PID 6699 | Values: 81.0 82.0 132.0 79.0 79.0 78.0 129.0 79.0 79.0 134.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#5] imaging-gaussian-blur Cycles:10 Average:114.90 Median:115.00 stddev:1.20 (1.0%) stddev-sans-first:1.27 11:21:01 INFO - PID 6699 | Values: 115.0 114.0 114.0 113.0 115.0 115.0 117.0 116.0 114.0 116.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#6] imaging-darkroom Cycles:10 Average:150.70 Median:151.00 stddev:1.49 (1.0%) stddev-sans-first:1.58 11:21:01 INFO - PID 6699 | Values: 151.0 152.0 151.0 152.0 151.0 150.0 153.0 150.0 148.0 149.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#7] imaging-desaturate Cycles:10 Average:94.30 Median:94.00 stddev:1.06 (1.1%) stddev-sans-first:1.12 11:21:01 INFO - PID 6699 | Values: 94.0 93.0 94.0 93.0 94.0 94.0 94.0 95.0 96.0 96.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#8] json-parse-financial Cycles:10 Average:57.20 Median:57.50 stddev:2.82 (4.9%) stddev-sans-first:2.07 11:21:01 INFO - PID 6699 | Values: 63.0 55.0 54.0 60.0 55.0 58.0 57.0 59.0 56.0 55.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#9] json-stringify-tinderbox Cycles:10 Average:56.60 Median:56.00 stddev:2.27 (4.1%) stddev-sans-first:2.40 11:21:01 INFO - PID 6699 | Values: 57.0 55.0 55.0 61.0 59.0 59.0 55.0 55.0 55.0 55.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#10] stanford-crypto-aes Cycles:10 Average:76.70 Median:76.00 stddev:2.83 (3.7%) stddev-sans-first:2.83 11:21:01 INFO - PID 6699 | Values: 74.0 76.0 75.0 74.0 75.0 76.0 80.0 81.0 81.0 75.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#11] stanford-crypto-ccm Cycles:10 Average:131.20 Median:130.50 stddev:11.81 (9.1%) stddev-sans-first:12.45 11:21:01 INFO - PID 6699 | Values: 135.0 137.0 122.0 127.0 124.0 130.0 120.0 125.0 131.0 161.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:176.70 Median:177.00 stddev:6.40 (3.6%) stddev-sans-first:6.44 11:21:01 INFO - PID 6699 | Values: 171.0 185.0 189.0 172.0 174.0 170.0 175.0 172.0 180.0 179.0 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.80 Median:71.50 stddev:3.22 (4.5%) stddev-sans-first:3.42 11:21:01 INFO - PID 6699 | Values: 71.0 70.0 70.0 72.0 72.0 77.0 74.0 69.0 66.0 67.0 11:21:01 INFO - PID 6699 | -------- Summary: end -------- 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | ###!!! [Parent][MessageChannel] Error: (msgtype=0x150079,name=PBrowser::Msg_Destroy) Closed channel: cannot send/recv 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | ###!!! [Child][MessageChannel] Error: (msgtype=0x150001,name=PBrowser::Msg_AsyncMessage) Closed channel: cannot send/recv 11:21:01 INFO - PID 6699 | 11:21:01 INFO - PID 6699 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 11:21:01 INFO - TEST-INFO | 6699: exit 0 11:21:01 INFO - TEST-OK | kraken | took 62615ms 11:21:01 INFO - SUITE-END | took 1174s 11:21:02 INFO - Completed test suite (00:19:35) 11:21:02 INFO - javascript benchmark 11:21:02 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8634.70577390983, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2995.1014695591343, 3105.4254962831865, 3161.351922855814, 3183.8408079596015, 3184.4108839864625, 6120.938790612093, 6240.563160578761, 6270.52971027173, 6275.4038366355235, 6278.089676996833, 5965.492933100681, 6068.998615228482, 6075.848103797396, 6093.299270583884, 6135.693215339226, 5642.294713160855, 5643.887122257553, 5644.463775941279, 5663.923854467658, 5670.914936275959, 5683.5169010634145, 5692.5161361284345, 5724.513416359614, 5743.483086522212, 5763.942360576403, 5669.829905102853, 5731.512821410185, 5750.971245143768, 5769.24999750034, 5773.595848290622, 5421.783128674848, 5509.283793106911, 5640.971795140998, 5649.209110724501, 5685.061964775807, 5526.0, 5554.638948468337, 5556.361018482886, 5587.106063029895, 5643.181738647914, 6000.069989151645, 6015.729292181819, 6024.939750602525, 6031.939680603182, 6135.785247516315, 6453.903191452132, 6503.479721622259, 6567.343265673442, 6582.76960306387, 6601.3068627794355, 6664.100346453215, 6667.899981500282, 6692.263850976388, 6693.0, 6696.229933557605, 6172.444479996821, 6192.907106393408, 6214.720337584774, 6217.658028808459, 6221.377862213788, 6731.966340168267, 6738.157730283715, 6758.763443279461, 6824.7952561423235, 6864.107666003388, 6410.0705397717065, 6437.324080971524, 6489.123968264224, 6508.60948343101, 6530.183727034121, 6655.101561289261, 6732.091167692397, 6742.9662851685425, 6772.187337519529, 6773.491988100912, 6677.165354330708, 6738.629375384303, 6739.359760822714, 6742.8651426972165, 6752.189737231563, 6630.104935833697, 6671.899921501182, 6675.632840193836, 6749.662516874137, 6793.762218322335, 5296.973515132399, 5333.7866485340155, 5335.573154147659, 5355.973220133875, 5517.779288828402, 4575.290829921301, 4618.861434156981, 4638.420197475316, 4652.069586082797, 4668.813247470063, 5741.425857414309, 5761.049426844607, 5828.329742079631, 5843.970780146072, 5848.122781582797, 6661.3005634408655, 6716.29478904708, 6754.6284954327, 6776.2546119926765, 6808.046873437723, 5678.3186017678145, 5752.511036561856, 5763.366029736726, 5777.480026797609, 5833.154192642043, 5901.675407852609, 5919.260092488439, 5934.673592952429, 5942.3166335871065, 5953.226080609493, 6331.398517140864, 6521.673916304166, 6522.902156467657, 6526.510511711641, 6538.476921846241, 6658.001299805068, 6661.800145995628, 6669.599824010575, 6749.696263668048, 6762.8985565217545, 6363.077353783768, 6444.13004244421, 6472.126262954441, 6495.220573531206, 6581.308962559054, 6543.901841472477, 6579.342065793382, 6595.835104122435, 6608.966955165193, 6610.438112760276, 6662.900056499253, 6664.400203981665, 6685.6322902240845, 6713.865722685421, 6757.459403247827, 6422.3577642235405, 6441.742330306923, 6455.580387274812, 6517.967410163109, 6544.54188206821, 6428.871422571616, 6446.161998940108, 6451.870962580629, 6454.612723236621, 6455.064015717789, 6189.226346706661, 6393.552451328363, 6394.808155755149, 6398.744050237939, 6410.935890641033, 6411.198600174978, 6478.6436745977535, 6573.1783527059115, 6612.570182938093, 6661.533692641662, 6267.780627678009, 6320.115183874169, 6347.523935704933, 6437.774677886251, 6446.226452825691], "value": 6065.1168665364985, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [774.5120574038355, 800.6237068577774, 813.99593002035, 832.8042909916169, 842.2588122452241, 41241.0, 41875.371869421986, 41926.9518262044, 42047.36928946061, 42206.7889660552, 38721.41917871234, 38810.8059459703, 38928.0, 38998.0, 39063.21873562534, 6862.416694580967, 6962.443004559623, 6978.476614253926, 6992.5105242633035, 6995.720171193172, 6899.206591241996, 7013.4389248860225, 7016.087908571904, 7020.543664661781, 7023.543469674455, 7694.076710794685, 7852.882206766903, 7880.172581878906, 7881.487703299296, 7893.605319734019, 7792.45452818303, 7848.529088254666, 7852.842943141105, 7858.017747781528, 7858.09631892334, 7562.3950083993695, 7668.578228197447, 7733.110692270348, 7733.96133019337, 7758.224177582253, 38862.80568597139, 38994.0, 39005.8546779927, 39055.60944390548, 39104.21791564181, 3474.322507111114, 3513.6135025147214, 3532.6467353264725, 3536.4341705327024, 3543.326767914088, 31891.52162717561, 31928.20179495508, 31986.0, 31992.520112198337, 31996.360072798645, 5106.004329155816, 5175.353080864892, 5194.974025129888, 5214.791408343662, 5217.060929032773, 182402.0, 183655.0, 188873.05563472232, 191683.0, 231609.9999999983, 50497.707694845616, 51325.23012154821, 51417.228741568906, 51456.48543514592, 51513.484865151615, 54709.0, 54765.452345476835, 54779.0, 54815.72592137014, 55201.72399137979, 16983.065931373894, 17039.659206815795, 17064.744028839577, 17147.657046858993, 17164.742528862076, 14046.578602641937, 14091.78862317066, 14099.083559568595, 14108.365123569463, 14206.502772403122, 15002.549923502313, 15042.849571504365, 15144.242787860783, 15229.771553426708, 15258.542243732705, 5972.970135149297, 6116.724747386378, 6184.752609895554, 6200.100985357098, 6229.719662615194, 1022.3559157730582, 1022.6880801355509, 1026.2303272545591, 1038.0864838941684, 1040.1003132290514, 23035.654465183037, 23445.296641100795, 28611.57082643762, 28706.425871482872, 29358.853205733834, 1101.0420933787657, 1104.7293413113678, 1111.5887121765, 1111.7387413957713, 1118.3010618363523, 12407.379631018413, 12488.144798186868, 12492.562760303346, 12548.623541293593, 12550.623481295575, 231157.0, 231405.0, 231836.0, 232273.0, 233936.0, 51519.48480515222, 52028.47971520236, 52201.0, 52220.73889630527, 52281.73859130756, 1475.8229012518352, 1485.7548504496638, 1503.3760989189363, 1513.0392200952253, 1518.2484670088156, 22304.330870073274, 22374.328770136923, 22612.547749045258, 22748.658770118793, 22846.086156554218, 37637.2472550542, 37638.24723505569, 37790.0, 37926.24147517089, 37991.81004094962, 196442.0, 196671.0, 196867.0, 197003.0, 197022.0, 30900.381992360475, 31329.843350784013, 31341.52987705232, 32983.17542061468, 34048.48927266044, 41143.7942810284, 41218.79390603028, 41240.58759412367, 41584.58415415928, 41934.580654193065, 28428.0, 29257.85371073131, 34421.655783442846, 35716.64283357237, 35900.64099358973, 34862.9541113767, 35018.474722878665, 35071.47392789059, 35073.1231719209, 35841.46237806383, 37356.0, 37477.0, 37619.62380376161, 37762.0, 37811.62188378191, 32989.17527061843, 33072.1731956703, 33189.50215746814, 33280.334393312485, 33732.66267337393, 23633.52732945366, 24065.619901510752, 24229.273121806375, 24290.87854560716, 24360.0], "value": 17401.173637597698, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [572.3303734630482, 574.8246784730658, 579.4611011759063, 584.1121495327101, 597.4921316880651, 22691.20580779673, 23018.07927682895, 23682.407939801513, 23748.64377034344, 23764.0, 26776.464470710573, 27049.0, 27291.0, 27311.317217069583, 27339.72660273397, 6323.77866774663, 6481.254655714582, 6486.189226346707, 6487.643179625119, 6490.870182596345, 6298.622082675054, 6502.2197336319705, 6526.869462610745, 6551.705173267214, 6604.933950660504, 6556.541042127029, 6558.409743123118, 6562.376574225441, 6579.374959378852, 6592.472602191837, 6593.044008618747, 6595.208574971034, 6595.53831231814, 6596.406323430891, 6601.14185155929, 6080.209572755513, 6092.147099406086, 6122.479589234876, 6128.693565321761, 6130.0, 29802.403951921056, 30624.846875765703, 30928.226794330098, 31250.374992500023, 31430.214244643837, 1946.5717542140706, 1980.564275859323, 1989.8109679580416, 1990.3531352310413, 1995.2019192323041, 19456.0, 20005.49986250341, 20305.898470507702, 20352.084156213004, 20479.89760051205, 2236.865788052722, 2250.4936389312275, 2272.125231785758, 2289.8511596746325, 2343.9531209375887, 140376.0, 146528.0, 146587.0, 147105.26447367802, 147228.0, 14722.926385368219, 15027.624309392353, 15165.317560709795, 15175.0, 15518.448155184617, 23825.40436489067, 23918.52162956766, 23924.401889952544, 24016.27951161468, 24030.0, 10282.177425805918, 10330.638427655147, 10594.841077383846, 10698.0, 10706.197035222389, 9567.091126342986, 9642.373245739005, 9664.130228279488, 9665.565049572646, 9864.112229899343, 9152.725418237464, 9398.248140148771, 9543.379680320757, 9570.665026724171, 9779.168770654433, 2672.3185587675407, 2721.9319517011836, 2749.0790585154195, 2756.145594865598, 2808.971910280871, 948.2224575847739, 965.5944503308627, 972.4651441707033, 992.8659630949729, 1002.3284399452384, 20508.0, 21063.26278580273, 21325.68011479829, 21378.89310553437, 21643.67534486984, 1037.9896201037893, 1045.5347370420243, 1051.3218973762034, 1057.4184198690843, 1058.0794708603564, 11516.769664606662, 11534.769304613861, 11580.594679186188, 11583.6524904253, 11603.883961160449, 520419.0, 524777.0, 532907.0, 534032.0, 536217.0, 120362.3981880085, 128101.35949320193, 128989.35505322414, 129981.0, 130789.34605327103, 1081.3511892864376, 1126.7126882644873, 1199.9460024298928, 1205.7046023724245, 1262.8421447319085, 21883.562328753018, 22000.229991950204, 22434.214802481834, 22517.887410562842, 22610.321690349316, 62524.374756253674, 63243.683781580796, 63681.68159159175, 64032.67983660052, 64621.0, 75748.62125689557, 75914.24085759293, 76753.61623191848, 76869.61565192362, 77221.61389193017, 20877.58244835125, 21472.355829325144, 21662.8916855421, 21750.78249217551, 21922.013509392436, 23246.0, 23982.52034959256, 24483.51032979295, 24677.62983555212, 24692.629610556214, 17806.46580602532, 18157.45527634173, 18343.26626934908, 18392.816071839112, 18412.723809142604, 17156.571085722957, 17273.91363043227, 17681.823181768017, 17892.642147157243, 18213.362532311305, 19414.417567473, 19435.0, 19580.11889464949, 19630.116644751306, 19734.802651973296, 21263.149474021484, 21335.933203340082, 21373.89313053425, 21466.463338416663, 21495.892520537298, 18571.350002749838, 18767.53081172927, 19255.422337329903, 19285.42143735634, 19334.419967401], "value": 12644.07714501727, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1362.3664995776962, 1402.9368678409471, 1419.6379923119596, 1421.9573412797606, 1424.4871846135393, 14445.422183112676, 14704.926475367609, 15020.248987550633, 15124.470643527478, 15143.242837858104, 15207.84792152078, 15449.613759656015, 15465.690686186297, 15472.381104755825, 15507.68984620307, 2728.6998430172666, 2771.390294135297, 2773.500769861424, 2776.3891943772437, 2780.819246748955, 2616.9738302617016, 2713.050432348672, 2815.521361368562, 2822.139247529503, 2822.4355128974184, 2730.481208570365, 2743.245607457945, 2757.9586306205424, 2758.2276962450446, 2762.9447411051765, 2693.4478431921407, 2715.416185520123, 2730.781537476997, 2742.478929003483, 2755.2147637923194, 2673.9331516712045, 2703.189043287006, 2712.4846279207086, 2722.8774705138117, 2726.5364887969095, 14594.416223351052, 14619.92690036543, 14641.780373294408, 14643.0, 14728.410863565445, 7586.241375862425, 7712.421568382338, 7964.203579642048, 8022.9598852005365, 8044.436889417743, 5226.895462090775, 5343.091674415358, 5436.374816896068, 5480.3971563128025, 5495.972520137374, 1818.7999320074782, 1838.0, 1869.12151288894, 1907.1513176636402, 1907.4659095453296, 24696.753032469624, 24871.378215544755, 24881.875590622112, 24883.875580622163, 24895.50208995828, 6660.333966603398, 6980.441564674814, 7046.9078998674495, 7263.0, 7266.128064632172, 16568.6686266274, 16698.916505417637, 16759.2458339375, 16779.748303775454, 16786.4124755633, 7736.7292144774665, 7863.764087077397, 7866.056073271244, 7869.803254918673, 7874.488158269694, 6288.591241569284, 7154.248803875622, 7215.098112735908, 7263.527870688388, 7348.412127029825, 4766.118268120409, 5282.841514754564, 5292.259083728281, 5413.48422441717, 5413.512783849473, 1521.5815650696147, 1534.7645145657852, 1540.5070377479324, 1544.9845501544842, 1558.4934896158793, 878.7451639024739, 894.4320356573622, 904.5590771509376, 913.5340976102236, 914.8673442350822, 8069.0317161939765, 8602.827943441096, 8616.827663446697, 8681.435706679045, 8720.476771393736, 977.7995510920387, 998.4259051045533, 1015.243643485608, 1015.5477666936351, 1021.1371391174446, 5343.973280133574, 5348.759305831247, 5578.2748242728185, 5599.132134519156, 5674.77300907959, 20131.19475221004, 20296.28962986318, 21089.894550527457, 21130.049147788388, 21131.471713206985, 20004.799952000583, 20555.8972205138, 20649.896750516153, 20727.067281972348, 21010.36968890936, 11033.724156896142, 11089.667309980714, 11216.327020378803, 11330.263532870336, 11392.25950313227, 8177.141400152898, 8296.917030829856, 8445.324374050184, 8498.91501085006, 8537.914620853711, 17304.394346197823, 17876.821231788035, 17943.820561794215, 18332.816671833112, 18681.346152884584, 17717.29130834752, 17722.0, 17779.11104444747, 17864.0, 17955.910220448815, 11990.220635658654, 12063.879361206276, 12138.211016284267, 12214.633560993185, 12217.816732749194, 13569.1858488491, 13693.383797728928, 13723.656908577366, 13745.656358591115, 13772.311384430537, 10785.568577256821, 10977.066949309397, 11188.720281993015, 11236.494357753758, 11257.49341279628, 10310.278280520592, 10325.328853624791, 10373.533191006272, 10419.322744021614, 10536.57853685844, 9603.135717785433, 9757.853632195382, 9819.116279534876, 9820.803583928424, 9824.950875245579, 7426.14599321085, 7464.253574642492, 7524.247575242651, 7547.849043019219, 7633.770986870402, 7470.365018973231, 7537.510061845963, 7564.205758395509, 7628.54228746277, 7746.264104910025], "value": 6661.982355655133, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [502.3532567610407, 515.889083846973, 523.861176788151, 526.3657292961981, 535.7696190638025, 6127.601705889119, 6196.566240363165, 6236.750529978806, 6239.6880155992185, 6330.177076979992, 6078.270607527092, 6099.603525770822, 6161.969190154043, 6191.876162476748, 6240.968795156018, 5166.328377310944, 5173.534381905628, 5194.142966410556, 5198.324217851693, 5198.870028249286, 4812.398450193726, 5069.997351046334, 5121.641485096045, 5125.564327032188, 5151.639385243035, 4864.124457597631, 4866.878328041792, 4911.607071434277, 4930.161872481687, 4964.032013757319, 4820.373351464323, 4907.656464047518, 4960.23116416956, 4970.925436118425, 4983.551480366748, 4339.7830108494445, 4398.274284743014, 4416.003516817285, 4459.509453960061, 4489.59593636571, 5930.436608522226, 5984.700764961734, 5989.790357337516, 6006.609570377911, 6033.788817391414, 5650.7790559381165, 5708.857278568027, 5718.59969802114, 5720.170575266605, 5723.885522289531, 6491.285958544557, 6511.316311787242, 6518.93481065188, 6528.771492997722, 6535.313792051814, 4819.2530157825595, 4832.855014349575, 4856.902861942742, 4910.975445122787, 4918.311436398907, 6495.837604059936, 6654.735600235939, 6668.466522678223, 6762.898556521656, 6901.102856628606, 4972.776225069881, 4989.706793516334, 5000.449950505442, 5049.394072711299, 5064.974675126675, 5051.924221136685, 5069.138246498104, 5083.415407228216, 5093.668911520739, 5104.3364362633365, 5685.3177618685195, 5686.402927692616, 5686.60193786431, 5696.743646535916, 5702.657840529581, 6592.044153597702, 6641.203055633258, 6646.86706265872, 6668.699908504129, 6681.465482761368, 1762.1629725880105, 1767.1605987156, 1768.2043080613776, 1771.9291228350721, 1784.2327799046534, 1161.6573110932295, 1203.9699007524882, 1213.5327898758865, 1221.6274036418977, 1230.1634888276058, 5802.854928626733, 5810.709464526757, 5835.94164058354, 5838.7446698959075, 5871.823845284648, 6719.664016799141, 6729.4279986200745, 6739.629320387426, 6752.5948443093575, 6795.150606174228, 5641.830745077655, 5693.206639908416, 5711.400302968212, 5740.397258287903, 5749.498967948955, 3513.4378499439968, 3533.9293214135573, 3564.9643503564635, 3572.982135089308, 3574.696150827157, 6453.483721302285, 6479.902801457982, 6498.902516462257, 6499.642519661464, 6560.868782624416, 6787.592744435251, 6835.726570937206, 6847.863042739217, 6855.01806714081, 6918.135233095863, 6395.488360931115, 6430.164078669836, 6446.580972236789, 6516.090345792487, 6522.28254891952, 6659.467242620482, 6669.766558170635, 6680.465562754871, 6719.529632925648, 6801.965990170215, 6067.54493412987, 6481.4814814815645, 6502.317256687979, 6648.301928297459, 6732.528722989539, 6297.433231009231, 6308.432241098323, 6352.968235158794, 6367.810234658738, 6538.901916471352, 4856.562909338177, 4947.703137811743, 4989.226669866177, 5009.073321435546, 5040.974795126148, 6368.306382298163, 6508.479321654161, 6547.544670748469, 6704.497162712719, 6787.185537735503, 6356.173697419306, 6399.872002560016, 6445.742170313135, 6543.550385737744, 6577.671116444254, 6349.428551430394, 6352.2531303889955, 6432.35676432353, 6459.801129266015, 6573.57271777333, 6338.8732225354315, 6382.936170638234, 6393.360663933569, 6423.614583125028, 6490.592438969578, 6466.935330646634, 6557.868842623217, 6589.7364105435245, 6644.136262285871, 6697.665116744241, 6313.494920406449, 6340.682965851781, 6342.651154186379, 6399.6800159992745, 6428.839279018062], "value": 5040.673891518212, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [897.9191872731457, 917.2066162769206, 920.167248639981, 929.2565947242205, 934.8410770169071, 19099.42701718949, 20165.798342016576, 20204.0, 20218.797812021876, 21887.890560547174, 21730.674039889414, 22414.439639008993, 22414.88792556035, 22415.0, 22422.215222467217, 994.6021591363458, 1013.0679774607379, 1015.7308313296983, 1016.0296916444814, 1017.6489111256604, 1027.0653705128334, 1062.2351906627255, 1065.8188108021616, 1065.9413732244723, 1081.7025318037563, 1097.7639807441399, 1099.6426161497504, 1100.1528822806433, 1100.2848148703326, 1108.4790148630132, 1096.627146770098, 1096.802575536403, 1096.9396683182422, 1098.4343063322356, 1106.88377720339, 804.0431886055575, 804.3324041045977, 804.5132694719669, 804.5936801915054, 809.7085049382217, 19450.0, 19594.412167634993, 19923.20307187725, 20026.1989520419, 20061.899690501454, 21187.5762484751, 21197.152113915425, 21607.1357145714, 21782.564348713095, 21789.673154902688, 17156.571085722957, 17158.39945601898, 17354.826451735447, 17379.913100434544, 17550.912245438692, 3678.981605091984, 3704.0, 3705.314516814398, 3710.07248187953, 3712.554493460775, 126595.0, 126658.3667081668, 127086.0, 130568.0, 133474.0, 16554.668906622042, 16572.917135414245, 16689.332426702797, 16901.577460563338, 16970.490885273462, 30686.69313306883, 31279.84360078185, 31302.06093817189, 32657.673423265463, 32799.50800737991, 7947.761567152995, 8316.750497485085, 8757.605907734167, 8827.073157318517, 9154.038825923315, 4405.493368262627, 4455.1980643484485, 4463.642908567307, 4463.866084017484, 4497.033137875373, 5254.842354729364, 5333.093374126408, 5377.623566350318, 5389.218563308376, 5418.431064738224, 1099.6536091131268, 1107.7175320293275, 1124.9887501125047, 1128.8532490776147, 1129.1136457880525, 695.1484431571284, 706.586646811621, 708.3919502728879, 710.4068103133837, 722.1767185408638, 10361.378317300987, 10902.781944361068, 11045.226834121535, 11339.319640821577, 12903.612891613267, 705.8376573388149, 706.7067167125585, 709.6806437103221, 717.9569225846466, 718.7807718645759, 5347.144456886879, 5469.726513674301, 5514.6139770216505, 5634.661920284796, 5685.516731077904, 108130.0, 110057.44971275092, 111192.0, 112724.0, 115555.0, 93357.0, 95051.52474237722, 95594.0, 95640.0, 96493.0, 85921.0, 86930.56534717286, 87255.0, 90932.0, 91244.54377728069, 10333.173346132442, 10421.531031103466, 10448.268621196443, 10676.359418434919, 10709.732256693645, 39096.41355379728, 39869.00327491836, 40333.39499907445, 40631.593684062784, 40933.0, 54444.0, 67858.0, 70794.0, 74147.62926185335, 75895.24104758882, 17235.827641723423, 19757.802421976172, 19946.0, 20056.799432006075, 20136.093875775332, 21443.892780536622, 21556.67664985058, 22102.88948555247, 22116.557668846854, 22256.554868902855, 17573.472795816146, 17659.38192163268, 17889.19498622539, 18027.639447211244, 18045.909770451588, 17260.309587616353, 17278.308867645657, 17731.734023989393, 18336.81663183351, 18525.90737046306, 16722.331106755595, 16867.0, 16993.32026718967, 17082.316707331567, 17164.82835171632, 12236.082293828176, 12647.177933434297, 12702.047346448868, 12728.363581821057, 12754.42605082755, 12583.0, 12752.553660621834, 12776.74446511083, 12810.55163069288, 13064.869351306745], "value": 9248.278462327069, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1533.2, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 108.0, 100.0, 107.0, 108.0, 110.0, 113.0, 100.0, 110.0, 110.0], "value": 107.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 121.0, 145.0, 178.0, 117.0, 147.0, 149.0, 117.0, 173.0, 118.0], "value": 141.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 162.0, 164.0, 163.0, 164.0, 163.0, 166.0, 170.0, 168.0, 164.0], "value": 164.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 86.0, 74.0, 182.0, 74.0, 83.0, 75.0, 76.0, 153.0, 76.0], "value": 95.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 82.0, 132.0, 79.0, 79.0, 78.0, 129.0, 79.0, 79.0, 134.0], "value": 95.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 114.0, 114.0, 113.0, 115.0, 115.0, 117.0, 116.0, 114.0, 116.0], "value": 114.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 152.0, 151.0, 152.0, 151.0, 150.0, 153.0, 150.0, 148.0, 149.0], "value": 150.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 93.0, 94.0, 93.0, 94.0, 94.0, 94.0, 95.0, 96.0, 96.0], "value": 94.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 55.0, 54.0, 60.0, 55.0, 58.0, 57.0, 59.0, 56.0, 55.0], "value": 57.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 55.0, 55.0, 61.0, 59.0, 59.0, 55.0, 55.0, 55.0, 55.0], "value": 56.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 76.0, 75.0, 74.0, 75.0, 76.0, 80.0, 81.0, 81.0, 75.0], "value": 76.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [135.0, 137.0, 122.0, 127.0, 124.0, 130.0, 120.0, 125.0, 131.0, 161.0], "value": 131.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 185.0, 189.0, 172.0, 174.0, 170.0, 175.0, 172.0, 180.0, 179.0], "value": 176.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 70.0, 70.0, 72.0, 72.0, 77.0, 74.0, 69.0, 66.0, 67.0], "value": 70.8, "unit": "score"}]}]} 11:21:02 INFO - Return code: 0 11:21:02 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:21:02 INFO - # TBPL SUCCESS # 11:21:02 INFO - Running post-action listener: _package_coverage_data 11:21:02 INFO - Running post-action listener: _resource_record_post_action 11:21:02 INFO - [mozharness: 2017-08-20 18:21:02.287635Z] Finished run-tests step (success) 11:21:02 INFO - Running post-run listener: _resource_record_post_run 11:21:02 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 4096; Write bytes: 437329920; Read time: 20; Write time: 421204 11:21:02 INFO - TinderboxPrint: CPU usage
13.2% 11:21:02 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 20 11:21:02 INFO - TinderboxPrint: I/O write bytes / time
437,329,920 / 421,204 11:21:02 INFO - TinderboxPrint: CPU idle
8,256.3 (86.8%) 11:21:02 INFO - TinderboxPrint: CPU user
1,201.1 (12.6%) 11:21:02 INFO - TinderboxPrint: Swap in / out
0 / 0 11:21:02 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 111063040; Read time: 0; Write time: 155204 11:21:02 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 11:21:02 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 326266880; Read time: 0; Write time: 266000 11:21:02 INFO - Running post-run listener: _upload_blobber_files 11:21:02 INFO - Blob upload gear active. 11:21:02 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:21:02 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 11:21:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:21:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:21:03 INFO - (blobuploader) - INFO - Open directory for files ... 11:21:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 11:21:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:21:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:21:04 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 11:21:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:21:04 INFO - (blobuploader) - INFO - Done attempting. 11:21:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:21:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:21:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:21:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:21:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:21:05 INFO - (blobuploader) - INFO - Done attempting. 11:21:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:21:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:21:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:21:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:21:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:21:05 INFO - (blobuploader) - INFO - Done attempting. 11:21:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:21:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:21:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:21:13 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:21:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:21:13 INFO - (blobuploader) - INFO - Done attempting. 11:21:13 INFO - (blobuploader) - INFO - Iteration through files over. 11:21:13 INFO - Return code: 0 11:21:13 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:21:13 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:21:13 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/78bd7b6c244e6ac2efa526e0aa42fc4acce5644b6e4ccf8b0013747833685ff63e021ee0da6606280d32c0b8c953ddd0aa14ccf8d2126ee3ccf4288cb521f049", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04ed7df80baf0d8386c85273c6f40e37b0baf50227dbee00a32c7926707eda15d9ec39c871f0d83110b7b6e6c53da69b34831e1154dd6f8aec998baa659fea89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ced0d048062de0bdddf414d7907c696b3e294ae285840a4ce301911b9f8e94963ac101a9a2cbbab9cd58408562c59c31469818e6a81c64ae8f8ebef7497f4252", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/75876609a26c6caf9af38e3fc880b23fda152ab6afab86ef591eb03114c7036da6fe5a94ae1be0aad0768d6c9995280958d0d04aedb91d6d431f1ab8c66a7a72"} 11:21:13 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:21:13 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:21:13 INFO - Contents: 11:21:13 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/78bd7b6c244e6ac2efa526e0aa42fc4acce5644b6e4ccf8b0013747833685ff63e021ee0da6606280d32c0b8c953ddd0aa14ccf8d2126ee3ccf4288cb521f049", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04ed7df80baf0d8386c85273c6f40e37b0baf50227dbee00a32c7926707eda15d9ec39c871f0d83110b7b6e6c53da69b34831e1154dd6f8aec998baa659fea89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ced0d048062de0bdddf414d7907c696b3e294ae285840a4ce301911b9f8e94963ac101a9a2cbbab9cd58408562c59c31469818e6a81c64ae8f8ebef7497f4252", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/75876609a26c6caf9af38e3fc880b23fda152ab6afab86ef591eb03114c7036da6fe5a94ae1be0aad0768d6c9995280958d0d04aedb91d6d431f1ab8c66a7a72"} 11:21:13 INFO - Running post-run listener: copy_logs_to_upload_dir 11:21:13 INFO - Copying logs to upload dir... 11:21:13 INFO - mkdir: /builds/slave/test/build/upload/logs 11:21:13 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1265.797538 ========= master_lag: 0.70 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2017-08-20 11:21:13.358566) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-20 11:21:13.360673) ========= 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=920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/78bd7b6c244e6ac2efa526e0aa42fc4acce5644b6e4ccf8b0013747833685ff63e021ee0da6606280d32c0b8c953ddd0aa14ccf8d2126ee3ccf4288cb521f049", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04ed7df80baf0d8386c85273c6f40e37b0baf50227dbee00a32c7926707eda15d9ec39c871f0d83110b7b6e6c53da69b34831e1154dd6f8aec998baa659fea89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ced0d048062de0bdddf414d7907c696b3e294ae285840a4ce301911b9f8e94963ac101a9a2cbbab9cd58408562c59c31469818e6a81c64ae8f8ebef7497f4252", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/75876609a26c6caf9af38e3fc880b23fda152ab6afab86ef591eb03114c7036da6fe5a94ae1be0aad0768d6c9995280958d0d04aedb91d6d431f1ab8c66a7a72"} build_url:https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011344 build_url: 'https://queue.taskcluster.net/v1/task/LJxQRdN-QvOV7_FMIYAiQw/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/78bd7b6c244e6ac2efa526e0aa42fc4acce5644b6e4ccf8b0013747833685ff63e021ee0da6606280d32c0b8c953ddd0aa14ccf8d2126ee3ccf4288cb521f049", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/04ed7df80baf0d8386c85273c6f40e37b0baf50227dbee00a32c7926707eda15d9ec39c871f0d83110b7b6e6c53da69b34831e1154dd6f8aec998baa659fea89", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ced0d048062de0bdddf414d7907c696b3e294ae285840a4ce301911b9f8e94963ac101a9a2cbbab9cd58408562c59c31469818e6a81c64ae8f8ebef7497f4252", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/75876609a26c6caf9af38e3fc880b23fda152ab6afab86ef591eb03114c7036da6fe5a94ae1be0aad0768d6c9995280958d0d04aedb91d6d431f1ab8c66a7a72"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-20 11:21:13.387106) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:21:13.387430) ========= 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=920470bf432669ad7e3a5387000001ca-1503250284.541203-1209605093 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004512 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-20 11:21:13.441013) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-20 11:21:13.443339) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-20 11:21:13.443635) ========= ========= Total master_lag: 0.86 =========