builder: mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s-pgo slave: talos-linux64-ix-013 starttime: 1505731985.52 results: success (0) revision: ffe6cc09ccf38cca6f0e727837bbc6cb722d1e71 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:05.522369) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:05.522890) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:05.527221) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:05.633639) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:05.633906) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-18 03:53:05-- 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% 111M=0s 2017-09-18 03:53:05 (111 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.385763 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.036940) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.037269) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020450 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.090966) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.091648) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev ffe6cc09ccf38cca6f0e727837bbc6cb722d1e71 --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 ffe6cc09ccf38cca6f0e727837bbc6cb722d1e71 --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=9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-18 03:53:06,089 truncating revision to first 12 chars 2017-09-18 03:53:06,089 Setting DEBUG logging. 2017-09-18 03:53:06,089 attempt 1/10 2017-09-18 03:53:06,089 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/ffe6cc09ccf3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-18 03:53:06,501 unpacking tar archive at: mozilla-central-ffe6cc09ccf3/testing/mozharness/ program finished with exit code 0 elapsedTime=0.769234 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.876884) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.880208) ========= script_repo_revision: ffe6cc09ccf38cca6f0e727837bbc6cb722d1e71 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.880842) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.881116) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-18 03:53:06.894620) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2017-09-18 03:53:06.894904) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-stylo-disabled-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-stylo-disabled-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=9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:53:07 INFO - MultiFileLogger online at 20170918 03:53:07 in /builds/slave/test 03:53:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-stylo-disabled-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 03:53:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:53:07 INFO - {'append_to_log': False, 03:53:07 INFO - 'base_work_dir': '/builds/slave/test', 03:53:07 INFO - 'blob_upload_branch': 'Firefox', 03:53:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:53:07 INFO - 'branch': 'Firefox', 03:53:07 INFO - 'buildbot_json_path': 'buildprops.json', 03:53:07 INFO - 'code_coverage': False, 03:53:07 INFO - 'config_files': ('talos/linux_config.py',), 03:53:07 INFO - 'default_actions': ('clobber', 03:53:07 INFO - 'read-buildbot-config', 03:53:07 INFO - 'download-and-extract', 03:53:07 INFO - 'populate-webroot', 03:53:07 INFO - 'create-virtualenv', 03:53:07 INFO - 'install', 03:53:07 INFO - 'setup-mitmproxy', 03:53:07 INFO - 'run-tests'), 03:53:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:53:07 INFO - 'disable_ccov_upload': False, 03:53:07 INFO - 'disable_stylo': False, 03:53:07 INFO - 'download_minidump_stackwalk': True, 03:53:07 INFO - 'download_symbols': 'ondemand', 03:53:07 INFO - 'enable_stylo': False, 03:53:07 INFO - 'enable_webrender': False, 03:53:07 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 03:53:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:53:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:53:07 INFO - 'gecko_profile': False, 03:53:07 INFO - 'gecko_profile_interval': 0, 03:53:07 INFO - 'installer_path': 'installer.exe', 03:53:07 INFO - 'log_level': 'info', 03:53:07 INFO - 'log_name': 'talos', 03:53:07 INFO - 'log_to_console': True, 03:53:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:53:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:53:07 INFO - 'opt_config_files': (), 03:53:07 INFO - 'pip_index': False, 03:53:07 INFO - 'suite': 'dromaeojs-stylo-disabled-e10s', 03:53:07 INFO - 'system_bits': '32', 03:53:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:53:07 INFO - 'title': 'talos-linux64-ix-013', 03:53:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:53:07 INFO - 'use_talos_json': True, 03:53:07 INFO - 'verify': 'False', 03:53:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:53:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:53:07 INFO - 'work_dir': 'build'} 03:53:07 INFO - [mozharness: 2017-09-18 10:53:07.038586Z] Running clobber step. 03:53:07 INFO - Running pre-action listener: _resource_record_pre_action 03:53:07 INFO - Running main action method: clobber 03:53:07 INFO - rmtree: /builds/slave/test/build 03:53:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:53:08 INFO - Running post-action listener: _resource_record_post_action 03:53:08 INFO - [mozharness: 2017-09-18 10:53:08.555326Z] Finished clobber step (success) 03:53:08 INFO - [mozharness: 2017-09-18 10:53:08.555423Z] Running read-buildbot-config step. 03:53:08 INFO - Running pre-action listener: _resource_record_pre_action 03:53:08 INFO - Running main action method: read_buildbot_config 03:53:08 INFO - Using buildbot properties: 03:53:08 INFO - { 03:53:08 INFO - "project": "", 03:53:08 INFO - "product": "firefox", 03:53:08 INFO - "who": "archaeopteryx@coole-files.de", 03:53:08 INFO - "installer_path": "public/build/target.tar.bz2", 03:53:08 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s", 03:53:08 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 03:53:08 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-stylo-disabled-e10s", 03:53:08 INFO - "stage_platform": "linux64-pgo", 03:53:08 INFO - "basedir": "/builds/slave/test", 03:53:08 INFO - "buildnumber": 30, 03:53:08 INFO - "platform": "ubuntu64_hw", 03:53:08 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 03:53:08 INFO - "slavebuilddir": "test", 03:53:08 INFO - "taskId": "IoUXDe2ITP6v6TJxvE-mtg", 03:53:08 INFO - "branch": "mozilla-central", 03:53:08 INFO - "script_repo_revision": "production", 03:53:08 INFO - "revision": "ffe6cc09ccf38cca6f0e727837bbc6cb722d1e71", 03:53:08 INFO - "slavename": "talos-linux64-ix-013", 03:53:08 INFO - "repo_path": "mozilla-central" 03:53:08 INFO - } 03:53:08 INFO - Finding installer, test and symbols from parent task. 03:53:08 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IoUXDe2ITP6v6TJxvE-mtg'}, attempt #1 03:53:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IoUXDe2ITP6v6TJxvE-mtg'}, attempt #1 03:53:09 INFO - Task dependencies: dezH6ewTQambwBP3-fZqzg 03:53:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg'}, attempt #1 03:53:09 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2 03:53:09 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.test_packages.json 03:53:09 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.crashreporter-symbols.zip 03:53:09 INFO - Running post-action listener: _resource_record_post_action 03:53:09 INFO - [mozharness: 2017-09-18 10:53:09.930010Z] Finished read-buildbot-config step (success) 03:53:09 INFO - [mozharness: 2017-09-18 10:53:09.930226Z] Running download-and-extract step. 03:53:09 INFO - Running pre-action listener: _resource_record_pre_action 03:53:09 INFO - Running main action method: download_and_extract 03:53:09 INFO - mkdir: /builds/slave/test/build/tests 03:53:09 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')]} 03:53:09 INFO - trying https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.test_packages.json 03:53:09 INFO - Downloading https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 03:53:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 03:53:10 INFO - Downloaded 989 bytes. 03:53:10 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 03:53:10 INFO - Using the following test package requirements: 03:53:10 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 03:53:10 INFO - u'common': [u'target.common.tests.zip'], 03:53:10 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 03:53:10 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 03:53:10 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 03:53:10 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 03:53:10 INFO - u'mozbase': [u'target.common.tests.zip'], 03:53:10 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 03:53:10 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 03:53:10 INFO - u'web-platform': [u'target.common.tests.zip', 03:53:10 INFO - u'target.web-platform.tests.tar.gz'], 03:53:10 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 03:53:10 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 03:53:10 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.common.tests.zip 03:53:10 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.common.tests.zip'}, attempt #1 03:53:10 INFO - Fetch https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.common.tests.zip into memory 03:53:12 INFO - Content-Length response header: 55318338 03:53:12 INFO - Bytes received: 55318338 03:53:22 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.talos.tests.zip 03:53:22 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 03:53:22 INFO - Fetch https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.talos.tests.zip into memory 03:53:24 INFO - Content-Length response header: 14508748 03:53:24 INFO - Bytes received: 14508748 03:53:24 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')]} 03:53:24 INFO - trying https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2 03:53:24 INFO - Downloading https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 03:53:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 03:53:26 INFO - Downloaded 62242364 bytes. 03:53:26 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2 03:53:26 INFO - mkdir: /builds/slave/test/properties 03:53:26 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:53:26 INFO - Writing to file /builds/slave/test/properties/build_url 03:53:26 INFO - Contents: 03:53:26 INFO - build_url:https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2 03:53:26 INFO - Running post-action listener: _resource_record_post_action 03:53:26 INFO - Running post-action listener: find_tests_for_verification 03:53:26 INFO - Running post-action listener: set_extra_try_arguments 03:53:26 INFO - [mozharness: 2017-09-18 10:53:26.955234Z] Finished download-and-extract step (success) 03:53:26 INFO - [mozharness: 2017-09-18 10:53:26.955351Z] Running populate-webroot step. 03:53:26 INFO - Running pre-action listener: _resource_record_pre_action 03:53:26 INFO - Running main action method: populate_webroot 03:53:26 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:53:26 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['tresize', 03:53:26 INFO - 'tcanvasmark']}, 03:53:26 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:53:26 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['dromaeo_css', 03:53:26 INFO - 'kraken']}, 03:53:26 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:53:26 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:53:26 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'tests': ['damp', 'tps']}, 03:53:26 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['damp', 'tps']}, 03:53:26 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:53:26 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['dromaeo_dom']}, 03:53:26 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 03:53:26 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['basic_compositor_video', 03:53:26 INFO - 'glvideo']}, 03:53:26 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 03:53:26 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['ts_paint_webext', 03:53:26 INFO - 'tp5o_webext']}, 03:53:26 INFO - 'other-e10s': {'tests': ['a11yr', 03:53:26 INFO - 'ts_paint', 03:53:26 INFO - 'tpaint', 03:53:26 INFO - 'sessionrestore', 03:53:26 INFO - 'sessionrestore_many_windows', 03:53:26 INFO - 'sessionrestore_no_auto_restore', 03:53:26 INFO - 'tabpaint']}, 03:53:26 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['a11yr', 03:53:26 INFO - 'ts_paint', 03:53:26 INFO - 'tpaint', 03:53:26 INFO - 'sessionrestore', 03:53:26 INFO - 'sessionrestore_many_windows', 03:53:26 INFO - 'sessionrestore_no_auto_restore', 03:53:26 INFO - 'tabpaint']}, 03:53:26 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 03:53:26 INFO - 'perf-reftest-singletons-e10s': {'tests': ['perf_reftest_singletons']}, 03:53:26 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['perf_reftest_singletons']}, 03:53:26 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['bloom_basic']}, 03:53:26 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:53:26 INFO - 'tsvgr_opacity', 03:53:26 INFO - 'tart', 03:53:26 INFO - 'tscrollx', 03:53:26 INFO - 'tsvg_static']}, 03:53:26 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['tsvgx', 03:53:26 INFO - 'tsvgr_opacity', 03:53:26 INFO - 'tart', 03:53:26 INFO - 'tscrollx', 03:53:26 INFO - 'tsvg_static']}, 03:53:26 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 03:53:26 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'talos_options': ['--disable-stylo'], 03:53:26 INFO - 'tests': ['tp5o']}, 03:53:26 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:53:26 INFO - 'talos_options': ['--mitmproxy', 03:53:26 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:53:26 INFO - '--firstNonBlankPaint'], 03:53:26 INFO - 'tests': ['tp6_google', 03:53:26 INFO - 'tp6_youtube', 03:53:26 INFO - 'tp6_amazon', 03:53:26 INFO - 'tp6_facebook']}, 03:53:26 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:53:26 INFO - 'talos_options': ['--disable-stylo', 03:53:26 INFO - '--mitmproxy', 03:53:26 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:53:26 INFO - '--firstNonBlankPaint'], 03:53:26 INFO - 'tests': ['tp6_google', 03:53:26 INFO - 'tp6_youtube', 03:53:26 INFO - 'tp6_amazon', 03:53:26 INFO - 'tp6_facebook']}, 03:53:26 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:53:26 INFO - 'talos_options': ['--stylo-threads=1', 03:53:26 INFO - '--mitmproxy', 03:53:26 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:53:26 INFO - '--firstNonBlankPaint'], 03:53:26 INFO - 'tests': ['tp6_google', 03:53:26 INFO - 'tp6_youtube', 03:53:26 INFO - 'tp6_amazon', 03:53:26 INFO - 'tp6_facebook']}, 03:53:26 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'talos_options': ['--xperf_path', 03:53:26 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:53:26 INFO - 'tests': ['tp5n']}, 03:53:26 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 03:53:26 INFO - 'talos_options': ['--disable-stylo', 03:53:26 INFO - '--xperf_path', 03:53:26 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:53:26 INFO - 'tests': ['tp5n']}}} 03:53:26 INFO - Running post-action listener: _resource_record_post_action 03:53:26 INFO - [mozharness: 2017-09-18 10:53:26.972670Z] Finished populate-webroot step (success) 03:53:26 INFO - [mozharness: 2017-09-18 10:53:26.972759Z] Running create-virtualenv step. 03:53:26 INFO - Running pre-action listener: _resource_record_pre_action 03:53:26 INFO - Running main action method: create_virtualenv 03:53:26 INFO - Creating virtualenv /builds/slave/test/build/venv 03:53:26 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 03:53:26 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 03:53:26 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 03:53:27 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:53:27 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:53:27 INFO - Installing distribute.............................................................................................................................................................................................done. 03:53:27 INFO - Installing pip...............done. 03:53:27 INFO - Return code: 0 03:53:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 03:53:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 03:53:27 INFO - Reading from file tmpfile_stdout 03:53:27 INFO - Output received: 03:53:27 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 03:53:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:53:27 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')]} 03:53:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:27 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')]} 03:53:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:27 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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:27 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 03:53:27 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 03:53:27 INFO - Using env: {'DISPLAY': ':0', 03:53:27 INFO - 'HOME': '/home/cltbld', 03:53:27 INFO - 'LANG': 'en_US.UTF-8', 03:53:27 INFO - 'LANGUAGE': 'en_US:en', 03:53:27 INFO - 'LOGNAME': 'cltbld', 03:53:27 INFO - 'MAIL': '/var/mail/cltbld', 03:53:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:27 INFO - 'MOZ_NO_REMOTE': '1', 03:53:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:27 INFO - 'NO_EM_RESTART': '1', 03:53:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:27 INFO - 'PWD': '/builds/slave/test', 03:53:27 INFO - 'SHELL': '/bin/bash', 03:53:27 INFO - 'SHLVL': '1', 03:53:27 INFO - 'TERM': 'linux', 03:53:27 INFO - 'TMOUT': '86400', 03:53:27 INFO - 'USER': 'cltbld', 03:53:27 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:27 INFO - '_': '/tools/buildbot/bin/python'} 03:53:29 INFO - Ignoring indexes: http://pypi.python.org/simple/ 03:53:29 INFO - Downloading/unpacking pip>=1.5 03:53:29 INFO - Running setup.py egg_info for package pip 03:53:29 INFO - warning: no files found matching 'pip/cacert.pem' 03:53:29 INFO - warning: no files found matching '*.html' under directory 'docs' 03:53:29 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 03:53:29 INFO - no previously-included directories found matching 'docs/_build/_sources' 03:53:29 INFO - Installing collected packages: pip 03:53:29 INFO - Found existing installation: pip 1.1 03:53:29 INFO - Uninstalling pip: 03:53:29 INFO - Successfully uninstalled pip 03:53:29 INFO - Running setup.py install for pip 03:53:29 INFO - warning: no files found matching 'pip/cacert.pem' 03:53:29 INFO - warning: no files found matching '*.html' under directory 'docs' 03:53:29 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 03:53:29 INFO - no previously-included directories found matching 'docs/_build/_sources' 03:53:29 INFO - Installing pip script to /builds/slave/test/build/venv/bin 03:53:29 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 03:53:29 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 03:53:29 INFO - Successfully installed pip 03:53:29 INFO - Cleaning up... 03:53:29 INFO - Return code: 0 03:53:29 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:53:29 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')]} 03:53:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:29 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')]} 03:53:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:29 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:29 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 03:53:29 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 03:53:29 INFO - Using env: {'DISPLAY': ':0', 03:53:29 INFO - 'HOME': '/home/cltbld', 03:53:29 INFO - 'LANG': 'en_US.UTF-8', 03:53:29 INFO - 'LANGUAGE': 'en_US:en', 03:53:29 INFO - 'LOGNAME': 'cltbld', 03:53:29 INFO - 'MAIL': '/var/mail/cltbld', 03:53:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:29 INFO - 'MOZ_NO_REMOTE': '1', 03:53:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:29 INFO - 'NO_EM_RESTART': '1', 03:53:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:29 INFO - 'PWD': '/builds/slave/test', 03:53:29 INFO - 'SHELL': '/bin/bash', 03:53:29 INFO - 'SHLVL': '1', 03:53:29 INFO - 'TERM': 'linux', 03:53:29 INFO - 'TMOUT': '86400', 03:53:29 INFO - 'USER': 'cltbld', 03:53:29 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:29 INFO - '_': '/tools/buildbot/bin/python'} 03:53:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:29 INFO - Downloading/unpacking psutil>=3.1.1 03:53:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:53:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:53:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:53:30 INFO - Installing collected packages: psutil 03:53:30 INFO - Running setup.py install for psutil 03:53:30 INFO - building 'psutil._psutil_linux' extension 03:53:30 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 03:53:30 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 03:53:30 INFO - building 'psutil._psutil_posix' extension 03:53:30 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 03:53:31 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 03:53:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:53:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:53:31 INFO - Successfully installed psutil 03:53:31 INFO - Cleaning up... 03:53:31 INFO - Return code: 0 03:53:31 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:53:31 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')]} 03:53:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:31 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')]} 03:53:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:31 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 03:53:31 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 03:53:31 INFO - Using env: {'DISPLAY': ':0', 03:53:31 INFO - 'HOME': '/home/cltbld', 03:53:31 INFO - 'LANG': 'en_US.UTF-8', 03:53:31 INFO - 'LANGUAGE': 'en_US:en', 03:53:31 INFO - 'LOGNAME': 'cltbld', 03:53:31 INFO - 'MAIL': '/var/mail/cltbld', 03:53:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:31 INFO - 'MOZ_NO_REMOTE': '1', 03:53:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:31 INFO - 'NO_EM_RESTART': '1', 03:53:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:31 INFO - 'PWD': '/builds/slave/test', 03:53:31 INFO - 'SHELL': '/bin/bash', 03:53:31 INFO - 'SHLVL': '1', 03:53:31 INFO - 'TERM': 'linux', 03:53:31 INFO - 'TMOUT': '86400', 03:53:31 INFO - 'USER': 'cltbld', 03:53:31 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:31 INFO - '_': '/tools/buildbot/bin/python'} 03:53:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:31 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:53:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:32 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:53:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:53:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:53:32 INFO - Installing collected packages: mozsystemmonitor 03:53:32 INFO - Running setup.py install for mozsystemmonitor 03:53:32 INFO - Successfully installed mozsystemmonitor 03:53:32 INFO - Cleaning up... 03:53:33 INFO - Return code: 0 03:53:33 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:53:33 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')]} 03:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:33 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')]} 03:53:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:33 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:33 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 03:53:33 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 03:53:33 INFO - Using env: {'DISPLAY': ':0', 03:53:33 INFO - 'HOME': '/home/cltbld', 03:53:33 INFO - 'LANG': 'en_US.UTF-8', 03:53:33 INFO - 'LANGUAGE': 'en_US:en', 03:53:33 INFO - 'LOGNAME': 'cltbld', 03:53:33 INFO - 'MAIL': '/var/mail/cltbld', 03:53:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:33 INFO - 'MOZ_NO_REMOTE': '1', 03:53:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:33 INFO - 'NO_EM_RESTART': '1', 03:53:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:33 INFO - 'PWD': '/builds/slave/test', 03:53:33 INFO - 'SHELL': '/bin/bash', 03:53:33 INFO - 'SHLVL': '1', 03:53:33 INFO - 'TERM': 'linux', 03:53:33 INFO - 'TMOUT': '86400', 03:53:33 INFO - 'USER': 'cltbld', 03:53:33 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:33 INFO - '_': '/tools/buildbot/bin/python'} 03:53:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:33 INFO - Downloading/unpacking jsonschema==2.5.1 03:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:34 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:53:34 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:53:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:34 INFO - Downloading functools32-3.2.3-2.tar.gz 03:53:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:53:35 INFO - warning: no files found matching '*.txt' 03:53:35 INFO - no previously-included directories found matching 'build' 03:53:35 INFO - no previously-included directories found matching 'dist' 03:53:35 INFO - no previously-included directories found matching '.git*' 03:53:35 INFO - Installing collected packages: jsonschema, functools32 03:53:35 INFO - Running setup.py install for functools32 03:53:36 INFO - warning: no files found matching '*.txt' 03:53:36 INFO - no previously-included directories found matching 'build' 03:53:36 INFO - no previously-included directories found matching 'dist' 03:53:36 INFO - no previously-included directories found matching '.git*' 03:53:36 INFO - Successfully installed jsonschema functools32 03:53:36 INFO - Cleaning up... 03:53:36 INFO - Return code: 0 03:53:36 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:53:36 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')]} 03:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:36 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')]} 03:53:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:36 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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:36 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 03:53:36 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 03:53:36 INFO - Using env: {'DISPLAY': ':0', 03:53:36 INFO - 'HOME': '/home/cltbld', 03:53:36 INFO - 'LANG': 'en_US.UTF-8', 03:53:36 INFO - 'LANGUAGE': 'en_US:en', 03:53:36 INFO - 'LOGNAME': 'cltbld', 03:53:36 INFO - 'MAIL': '/var/mail/cltbld', 03:53:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:36 INFO - 'MOZ_NO_REMOTE': '1', 03:53:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:36 INFO - 'NO_EM_RESTART': '1', 03:53:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:36 INFO - 'PWD': '/builds/slave/test', 03:53:36 INFO - 'SHELL': '/bin/bash', 03:53:36 INFO - 'SHLVL': '1', 03:53:36 INFO - 'TERM': 'linux', 03:53:36 INFO - 'TMOUT': '86400', 03:53:36 INFO - 'USER': 'cltbld', 03:53:36 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:36 INFO - '_': '/tools/buildbot/bin/python'} 03:53:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:36 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:53:36 INFO - Cleaning up... 03:53:36 INFO - Return code: 0 03:53:36 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:53:36 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')]} 03:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:36 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')]} 03:53:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:36 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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:36 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 03:53:36 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 03:53:36 INFO - Using env: {'DISPLAY': ':0', 03:53:36 INFO - 'HOME': '/home/cltbld', 03:53:36 INFO - 'LANG': 'en_US.UTF-8', 03:53:36 INFO - 'LANGUAGE': 'en_US:en', 03:53:36 INFO - 'LOGNAME': 'cltbld', 03:53:36 INFO - 'MAIL': '/var/mail/cltbld', 03:53:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:36 INFO - 'MOZ_NO_REMOTE': '1', 03:53:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:36 INFO - 'NO_EM_RESTART': '1', 03:53:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:36 INFO - 'PWD': '/builds/slave/test', 03:53:36 INFO - 'SHELL': '/bin/bash', 03:53:36 INFO - 'SHLVL': '1', 03:53:36 INFO - 'TERM': 'linux', 03:53:36 INFO - 'TMOUT': '86400', 03:53:36 INFO - 'USER': 'cltbld', 03:53:36 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:36 INFO - '_': '/tools/buildbot/bin/python'} 03:53:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:36 INFO - Downloading/unpacking blobuploader==1.2.4 03:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:37 INFO - Downloading blobuploader-1.2.4.tar.gz 03:53:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:53:37 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:53:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:53:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:53:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:53:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:53:38 INFO - Downloading docopt-0.6.1.tar.gz 03:53:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:53:38 INFO - Installing collected packages: blobuploader, requests, docopt 03:53:38 INFO - Running setup.py install for blobuploader 03:53:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:53:38 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:53:38 INFO - Running setup.py install for requests 03:53:38 INFO - Running setup.py install for docopt 03:53:38 INFO - Successfully installed blobuploader requests docopt 03:53:38 INFO - Cleaning up... 03:53:38 INFO - Return code: 0 03:53:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:53:38 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')]} 03:53:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:38 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')]} 03:53:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:38 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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:38 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 03:53:38 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 03:53:38 INFO - Using env: {'DISPLAY': ':0', 03:53:38 INFO - 'HOME': '/home/cltbld', 03:53:38 INFO - 'LANG': 'en_US.UTF-8', 03:53:38 INFO - 'LANGUAGE': 'en_US:en', 03:53:38 INFO - 'LOGNAME': 'cltbld', 03:53:38 INFO - 'MAIL': '/var/mail/cltbld', 03:53:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:38 INFO - 'MOZ_NO_REMOTE': '1', 03:53:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:38 INFO - 'NO_EM_RESTART': '1', 03:53:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:38 INFO - 'PWD': '/builds/slave/test', 03:53:38 INFO - 'SHELL': '/bin/bash', 03:53:38 INFO - 'SHLVL': '1', 03:53:38 INFO - 'TERM': 'linux', 03:53:38 INFO - 'TMOUT': '86400', 03:53:38 INFO - 'USER': 'cltbld', 03:53:38 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:38 INFO - '_': '/tools/buildbot/bin/python'} 03:53:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:53:39 INFO - Running setup.py (path:/tmp/pip-kHN415-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:53:39 INFO - Running setup.py (path:/tmp/pip-8JQZu3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:53:39 INFO - Running setup.py (path:/tmp/pip-LH9zow-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:53:39 INFO - Running setup.py (path:/tmp/pip-Dnm66Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:53:39 INFO - Running setup.py (path:/tmp/pip-fmB1Cp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:53:39 INFO - Running setup.py (path:/tmp/pip-pgkbet-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:53:39 INFO - Running setup.py (path:/tmp/pip-_zAxdC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:53:39 INFO - Running setup.py (path:/tmp/pip-pwM_sg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:53:39 INFO - Running setup.py (path:/tmp/pip-jiOQE9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:53:39 INFO - Running setup.py (path:/tmp/pip-tRVjlN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:53:39 INFO - Running setup.py (path:/tmp/pip-fegaLE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:53:39 INFO - Running setup.py (path:/tmp/pip-m3PnDu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:53:39 INFO - Running setup.py (path:/tmp/pip-as5cQf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:53:40 INFO - Running setup.py (path:/tmp/pip-QTmBw0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:53:40 INFO - Running setup.py (path:/tmp/pip-7Rq9PN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:53:40 INFO - Running setup.py (path:/tmp/pip-Z4CZ7D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:53:40 INFO - Running setup.py (path:/tmp/pip-cfZAgG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:53:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:53:40 INFO - Running setup.py install for manifestparser 03:53:40 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:53:40 INFO - Running setup.py install for mozcrash 03:53:40 INFO - Running setup.py install for mozdebug 03:53:40 INFO - Running setup.py install for mozdevice 03:53:40 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:53:40 INFO - Running setup.py install for mozfile 03:53:40 INFO - Running setup.py install for mozhttpd 03:53:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:53:40 INFO - Running setup.py install for mozinfo 03:53:41 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Running setup.py install for mozInstall 03:53:41 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Running setup.py install for mozleak 03:53:41 INFO - Running setup.py install for mozlog 03:53:41 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Running setup.py install for moznetwork 03:53:41 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Running setup.py install for mozprocess 03:53:41 INFO - Running setup.py install for mozprofile 03:53:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Running setup.py install for mozrunner 03:53:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:53:41 INFO - Running setup.py install for mozscreenshot 03:53:41 INFO - Running setup.py install for moztest 03:53:41 INFO - Running setup.py install for mozversion 03:53:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:53:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:53:42 INFO - Cleaning up... 03:53:42 INFO - Return code: 0 03:53:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:53:42 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')]} 03:53:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:42 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')]} 03:53:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:42 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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:42 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 03:53:42 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 03:53:42 INFO - Using env: {'DISPLAY': ':0', 03:53:42 INFO - 'HOME': '/home/cltbld', 03:53:42 INFO - 'LANG': 'en_US.UTF-8', 03:53:42 INFO - 'LANGUAGE': 'en_US:en', 03:53:42 INFO - 'LOGNAME': 'cltbld', 03:53:42 INFO - 'MAIL': '/var/mail/cltbld', 03:53:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:42 INFO - 'MOZ_NO_REMOTE': '1', 03:53:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:42 INFO - 'NO_EM_RESTART': '1', 03:53:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:42 INFO - 'PWD': '/builds/slave/test', 03:53:42 INFO - 'SHELL': '/bin/bash', 03:53:42 INFO - 'SHLVL': '1', 03:53:42 INFO - 'TERM': 'linux', 03:53:42 INFO - 'TMOUT': '86400', 03:53:42 INFO - 'USER': 'cltbld', 03:53:42 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:42 INFO - '_': '/tools/buildbot/bin/python'} 03:53:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:53:42 INFO - Running setup.py (path:/tmp/pip-mml91t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:53:42 INFO - Running setup.py (path:/tmp/pip-hbizXr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:53:42 INFO - Running setup.py (path:/tmp/pip-Gqvb8m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:53:42 INFO - Running setup.py (path:/tmp/pip-3Ep6B0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:53:42 INFO - Running setup.py (path:/tmp/pip-ghaOOS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:53:42 INFO - Running setup.py (path:/tmp/pip-kL_wkT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:53:42 INFO - Running setup.py (path:/tmp/pip-YsEAhT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:53:42 INFO - Running setup.py (path:/tmp/pip-ilICLw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:53:42 INFO - Running setup.py (path:/tmp/pip-G6jrHu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:53:42 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)) 03:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:53:42 INFO - Running setup.py (path:/tmp/pip-sjf3QP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:53:43 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)) 03:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:53:43 INFO - Running setup.py (path:/tmp/pip-b1MTuB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:53:43 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)) 03:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:53:43 INFO - Running setup.py (path:/tmp/pip-qsB5SA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:53:43 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)) 03:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:53:43 INFO - Running setup.py (path:/tmp/pip-E9ibmZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:53:43 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)) 03:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:53:43 INFO - Running setup.py (path:/tmp/pip-ZaFvbc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:53:43 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)) 03:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:53:43 INFO - Running setup.py (path:/tmp/pip-nxk3sq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:53:43 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)) 03:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:53:43 INFO - Running setup.py (path:/tmp/pip-swt2mb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:53:43 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)) 03:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:53:43 INFO - Running setup.py (path:/tmp/pip-o9c07_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:53:43 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)) 03:53:43 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)) 03:53:43 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)) 03:53:43 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)) 03:53:43 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)) 03:53:43 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)) 03:53:43 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)) 03:53:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:53:43 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 03:53:43 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 03:53:43 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 03:53:43 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 03:53:44 INFO - Downloading blessings-1.6.tar.gz 03:53:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:53:44 INFO - Installing collected packages: blessings 03:53:44 INFO - Running setup.py install for blessings 03:53:44 INFO - Successfully installed blessings 03:53:44 INFO - Cleaning up... 03:53:44 INFO - Return code: 0 03:53:44 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:53:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:53:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:53:45 INFO - Reading from file tmpfile_stdout 03:53:45 INFO - Current package versions: 03:53:45 INFO - argparse == 1.2.1 03:53:45 INFO - blessings == 1.6 03:53:45 INFO - blobuploader == 1.2.4 03:53:45 INFO - docopt == 0.6.1 03:53:45 INFO - functools32 == 3.2.3-2 03:53:45 INFO - jsonschema == 2.5.1 03:53:45 INFO - manifestparser == 1.1 03:53:45 INFO - mozInstall == 1.13 03:53:45 INFO - mozcrash == 1.0 03:53:45 INFO - mozdebug == 0.1 03:53:45 INFO - mozdevice == 0.51 03:53:45 INFO - mozfile == 1.2 03:53:45 INFO - mozhttpd == 0.7 03:53:45 INFO - mozinfo == 0.10 03:53:45 INFO - mozleak == 0.1 03:53:45 INFO - mozlog == 3.5 03:53:45 INFO - moznetwork == 0.27 03:53:45 INFO - mozprocess == 0.25 03:53:45 INFO - mozprofile == 0.28 03:53:45 INFO - mozrunner == 6.13 03:53:45 INFO - mozscreenshot == 0.1 03:53:45 INFO - mozsystemmonitor == 0.3 03:53:45 INFO - moztest == 0.8 03:53:45 INFO - mozversion == 1.4 03:53:45 INFO - psutil == 3.1.1 03:53:45 INFO - requests == 1.2.3 03:53:45 INFO - wsgiref == 0.1.2 03:53:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:53:45 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')]} 03:53:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:45 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')]} 03:53:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:45 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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:45 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 03:53:45 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 03:53:45 INFO - Using env: {'DISPLAY': ':0', 03:53:45 INFO - 'HOME': '/home/cltbld', 03:53:45 INFO - 'LANG': 'en_US.UTF-8', 03:53:45 INFO - 'LANGUAGE': 'en_US:en', 03:53:45 INFO - 'LOGNAME': 'cltbld', 03:53:45 INFO - 'MAIL': '/var/mail/cltbld', 03:53:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:45 INFO - 'MOZ_NO_REMOTE': '1', 03:53:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:45 INFO - 'NO_EM_RESTART': '1', 03:53:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:45 INFO - 'PWD': '/builds/slave/test', 03:53:45 INFO - 'SHELL': '/bin/bash', 03:53:45 INFO - 'SHLVL': '1', 03:53:45 INFO - 'TERM': 'linux', 03:53:45 INFO - 'TMOUT': '86400', 03:53:45 INFO - 'USER': 'cltbld', 03:53:45 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:45 INFO - '_': '/tools/buildbot/bin/python'} 03:53:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:45 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)) 03:53:45 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)) 03:53:45 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)) 03:53:45 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)) 03:53:45 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)) 03:53:45 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)) 03:53:45 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)) 03:53:45 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)) 03:53:45 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)) 03:53:45 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 03:53:45 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 03:53:45 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 03:53:45 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 03:53:45 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 03:53:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 03:53:46 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)) 03:53:46 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)) 03:53:46 INFO - Installing collected packages: simplejson 03:53:46 INFO - Running setup.py install for simplejson 03:53:46 INFO - building 'simplejson._speedups' extension 03:53:46 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 03:53:47 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 03:53:47 INFO - Successfully installed simplejson 03:53:47 INFO - Cleaning up... 03:53:47 INFO - Return code: 0 03:53:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:53:47 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')]} 03:53:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:53:47 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')]} 03:53:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:53:47 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 0x25be1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2787a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x292aa60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, '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': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', '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 03:53:47 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 03:53:47 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 03:53:47 INFO - Using env: {'DISPLAY': ':0', 03:53:47 INFO - 'HOME': '/home/cltbld', 03:53:47 INFO - 'LANG': 'en_US.UTF-8', 03:53:47 INFO - 'LANGUAGE': 'en_US:en', 03:53:47 INFO - 'LOGNAME': 'cltbld', 03:53:47 INFO - 'MAIL': '/var/mail/cltbld', 03:53:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:53:47 INFO - 'MOZ_NO_REMOTE': '1', 03:53:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:53:47 INFO - 'NO_EM_RESTART': '1', 03:53:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:53:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:53:47 INFO - 'PWD': '/builds/slave/test', 03:53:47 INFO - 'SHELL': '/bin/bash', 03:53:47 INFO - 'SHLVL': '1', 03:53:47 INFO - 'TERM': 'linux', 03:53:47 INFO - 'TMOUT': '86400', 03:53:47 INFO - 'USER': 'cltbld', 03:53:47 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:53:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:53:47 INFO - '_': '/tools/buildbot/bin/python'} 03:53:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:53:47 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:53:47 INFO - Cleaning up... 03:53:47 INFO - Return code: 0 03:53:47 INFO - Running post-action listener: _resource_record_post_action 03:53:47 INFO - Running post-action listener: _start_resource_monitoring 03:53:47 INFO - Starting resource monitoring. 03:53:47 INFO - [mozharness: 2017-09-18 10:53:47.858071Z] Finished create-virtualenv step (success) 03:53:47 INFO - [mozharness: 2017-09-18 10:53:47.858696Z] Running install step. 03:53:47 INFO - Running pre-action listener: _resource_record_pre_action 03:53:47 INFO - Running main action method: install 03:53:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:53:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:53:48 INFO - Reading from file tmpfile_stdout 03:53:48 INFO - Detecting whether we're running mozinstall >=1.0... 03:53:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:53:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:53:48 INFO - Reading from file tmpfile_stdout 03:53:48 INFO - Output received: 03:53:48 INFO - Usage: mozinstall [options] installer 03:53:48 INFO - Options: 03:53:48 INFO - -h, --help show this help message and exit 03:53:48 INFO - -d DEST, --destination=DEST 03:53:48 INFO - Directory to install application into. [default: 03:53:48 INFO - "/builds/slave/test"] 03:53:48 INFO - --app=APP Application being installed. [default: firefox] 03:53:48 INFO - mkdir: /builds/slave/test/build/application 03:53:48 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'] 03:53:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 03:54:05 INFO - Reading from file tmpfile_stdout 03:54:05 INFO - Output received: 03:54:05 INFO - /builds/slave/test/build/application/firefox/firefox 03:54:05 INFO - Running post-action listener: _resource_record_post_action 03:54:05 INFO - [mozharness: 2017-09-18 10:54:05.845884Z] Finished install step (success) 03:54:05 INFO - [mozharness: 2017-09-18 10:54:05.845993Z] Running setup-mitmproxy step. 03:54:05 INFO - Running pre-action listener: _resource_record_pre_action 03:54:05 INFO - Running main action method: setup_mitmproxy 03:54:05 INFO - Skipping: mitmproxy is not required 03:54:05 INFO - Running post-action listener: _resource_record_post_action 03:54:05 INFO - [mozharness: 2017-09-18 10:54:05.846769Z] Finished setup-mitmproxy step (success) 03:54:05 INFO - [mozharness: 2017-09-18 10:54:05.846990Z] Running run-tests step. 03:54:05 INFO - Running pre-action listener: _resource_record_pre_action 03:54:05 INFO - Running pre-action listener: _set_gcov_prefix 03:54:05 INFO - Running main action method: run_tests 03:54:05 WARNING - Try message not found. 03:54:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:54:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:54:05 INFO - Python 2.7.3 03:54:05 INFO - Return code: 0 03:54:05 INFO - grabbing minidump binary from tooltool 03:54: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')]} 03:54:05 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 0x292e090>, '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 0x292ed80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2928f90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:54:05 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 03:54:05 INFO - Copy/paste: /tools/tooltool.py --url https://tooltool.mozilla-releng.net/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 03:54:05 INFO - Calling ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 03:54:05 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:54:05 INFO - Return code: 0 03:54:05 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:54:05 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:54:05 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:54:05 INFO - ENV: RUST_BACKTRACE is now full 03:54:05 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:54:05 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:54:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-stylo-disabled-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log'] in /builds/slave/test/build 03:54:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-stylo-disabled-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-013 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log 03:54:05 INFO - Using env: {'DISPLAY': ':0', 03:54:05 INFO - 'HOME': '/home/cltbld', 03:54:05 INFO - 'LANG': 'en_US.UTF-8', 03:54:05 INFO - 'LANGUAGE': 'en_US:en', 03:54:05 INFO - 'LOGNAME': 'cltbld', 03:54:05 INFO - 'MAIL': '/var/mail/cltbld', 03:54:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:54:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:54:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:05 INFO - 'MOZ_NO_REMOTE': '1', 03:54:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:54:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:05 INFO - 'NO_EM_RESTART': '1', 03:54:05 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:05 INFO - 'PWD': '/builds/slave/test', 03:54:05 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:54:05 INFO - 'RUST_BACKTRACE': 'full', 03:54:05 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 03:54:05 INFO - 'SHELL': '/bin/bash', 03:54:05 INFO - 'SHLVL': '1', 03:54:05 INFO - 'TERM': 'linux', 03:54:05 INFO - 'TMOUT': '86400', 03:54:05 INFO - 'USER': 'cltbld', 03:54:05 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:54:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:05 INFO - '_': '/tools/buildbot/bin/python'} 03:54:05 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-stylo-disabled-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log'] with output_timeout 3600 03:54:06 INFO - mozversion application_buildid: 20170918093516 03:54:06 INFO - mozversion application_changeset: ffe6cc09ccf38cca6f0e727837bbc6cb722d1e71 03:54:06 INFO - mozversion application_display_name: Nightly 03:54:06 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:54:06 INFO - mozversion application_name: Firefox 03:54:06 INFO - mozversion application_remotingname: firefox 03:54:06 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 03:54:06 INFO - mozversion application_vendor: Mozilla 03:54:06 INFO - mozversion application_version: 57.0a1 03:54:06 INFO - mozversion platform_buildid: 20170918093516 03:54:06 INFO - mozversion platform_changeset: ffe6cc09ccf38cca6f0e727837bbc6cb722d1e71 03:54:06 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 03:54:06 INFO - mozversion platform_version: 57.0a1 03:54:06 INFO - using testdate: 1505732046 03:54:06 INFO - actual date: 1505732046 03:54:06 INFO - starting webserver on 'localhost:36223' 03:54:06 INFO - SUITE-START | Running 2 tests 03:54:06 INFO - TEST-START | dromaeo_css 03:54:06 INFO - Initialising browser for dromaeo_css test... 03:54:06 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:36223/getInfo.html -profile /tmp/tmpwmz5Id/profile 03:54:06 INFO - TEST-INFO | started process 12631 (/builds/slave/test/build/application/firefox/firefox http://localhost:36223/getInfo.html) 03:54:12 INFO - TEST-INFO | 12631: exit 0 03:54:12 INFO - Browser initialized. 03:54:12 INFO - Running cycle 1/1 for dromaeo_css test... 03:54:12 INFO - Using env: {'DISPLAY': ':0', 03:54:12 INFO - 'HOME': '/home/cltbld', 03:54:12 INFO - 'JSGC_DISABLE_POISONING': '1', 03:54:12 INFO - 'LANG': 'en_US.UTF-8', 03:54:12 INFO - 'LANGUAGE': 'en_US:en', 03:54:12 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 03:54:12 INFO - 'LOGNAME': 'cltbld', 03:54:12 INFO - 'MAIL': '/var/mail/cltbld', 03:54:12 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:54:12 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:54:12 INFO - 'MOZ_CRASHREPORTER': '1', 03:54:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:12 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 03:54:12 INFO - 'MOZ_NO_REMOTE': '1', 03:54:12 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:54:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:12 INFO - 'NO_EM_RESTART': '1', 03:54:12 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:12 INFO - 'PWD': '/builds/slave/test', 03:54:12 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:54:12 INFO - 'RUST_BACKTRACE': 'full', 03:54:12 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 03:54:12 INFO - 'SHELL': '/bin/bash', 03:54:12 INFO - 'SHLVL': '1', 03:54:12 INFO - 'STYLO_FORCE_DISABLED': '1', 03:54:12 INFO - 'TERM': 'linux', 03:54:12 INFO - 'TMOUT': '86400', 03:54:12 INFO - 'USER': 'cltbld', 03:54:12 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 03:54:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:12 INFO - '_': '/tools/buildbot/bin/python'} 03:54:12 INFO - TEST-INFO | started process 12868 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwmz5Id/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 03:54:12 INFO - PID 12868 | 03:54:12 INFO - PID 12868 | (/builds/slave/test/build/application/firefox/firefox:12918): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 03:54:12 INFO - PID 12868 | 03:54:23 INFO - PID 12868 | RSS: Main: 148017152 03:54:23 INFO - PID 12868 | 03:57:19 INFO - PID 12868 | Cycle 1(1): loaded http://localhost:36223/tests/dromaeo/cssquery-dojo.html (next: http://localhost:36223/tests/dromaeo/cssquery-ext.html) 03:57:21 INFO - PID 12868 | RSS: Main: 149262336 03:57:21 INFO - PID 12868 | 04:00:23 INFO - PID 12868 | Cycle 1(1): loaded http://localhost:36223/tests/dromaeo/cssquery-ext.html (next: http://localhost:36223/tests/dromaeo/cssquery-jquery.html) 04:00:23 INFO - PID 12868 | RSS: Main: 148869120 04:00:23 INFO - PID 12868 | 04:03:25 INFO - PID 12868 | Cycle 1(1): loaded http://localhost:36223/tests/dromaeo/cssquery-jquery.html (next: http://localhost:36223/tests/dromaeo/cssquery-mootools.html) 04:03:25 INFO - PID 12868 | RSS: Main: 151502848 04:03:25 INFO - PID 12868 | 04:06:27 INFO - PID 12868 | Cycle 1(1): loaded http://localhost:36223/tests/dromaeo/cssquery-mootools.html (next: http://localhost:36223/tests/dromaeo/cssquery-prototype.html) 04:06:27 INFO - PID 12868 | RSS: Main: 149360640 04:06:27 INFO - PID 12868 | 04:09:30 INFO - PID 12868 | Cycle 1(1): loaded http://localhost:36223/tests/dromaeo/cssquery-prototype.html (next: http://localhost:36223/tests/dromaeo/cssquery-yui.html) 04:09:31 INFO - PID 12868 | RSS: Main: 151199744 04:09:31 INFO - PID 12868 | 04:12:32 INFO - PID 12868 | Cycle 1(1): loaded http://localhost:36223/tests/dromaeo/cssquery-yui.html (next: http://localhost:36223/tests/dromaeo/cssquery-dojo.html) 04:12:33 INFO - PID 12868 | RSS: Main: 153153536 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | __start_tp_report 04:12:33 INFO - PID 12868 | _x_x_mozilla_page_load 04:12:33 INFO - PID 12868 | _x_x_mozilla_page_load_details 04:12:33 INFO - PID 12868 | |i|pagename|runs| 04:12:33 INFO - PID 12868 | |0;dojo.html;3882.825272862721;3897.220555888823;3907.1794923066154;3917.902052448687;3921.0785465415624;6206.379362063792;6268.498520118391;6282.246130464345;6283.748650053998;6287.748490060392;6283.4030767077165;6289.213848268966;6344.651044192579;6347.30179680236;6357.841053973653;5618.775248990036;5664.801731939373;5685.1756495308155;5744.4829965303115;5771.50942169916;5666.716664166795;5736.2542869427125;5748.942510574903;5755.079187330028;5757.798477053304;194.27676986017124;5533.031719449121;5562.193481945135;5728.484436400723;5734.942650573504;5539.861503462405;5563.721813909288;5629.57778166635;5641.661500309953;5646.378898321182;5566.666000040011;5578.470045345726;5632.07070833312;5645.379008309083;5653.886922261573;6174.413430724074;6176;6183.134361189437;6234.875302493925;6263.34234905333;6697.151945921736;6700.195976482804;6793;6798.728050877959;6818.249992500821;6726.260111387744;6756.864862702768;6765.289644587297;6838.14523184602;6848.383645471881;6225.284092329395;6270.529710271702;6277.968610156966;6289.559730818844;6308.779192728279;6859.416949559243;6863.519553631298;6945.89581156283;6958.269381714948;6997.825054373681;6514.120593719787;6562.376574225441;6632;6666.600003999775;6710.295418981034;6889.758858439931;6914.51598388108;6950.165980082423;6960.65196740161;6977.441804655616;6779.796606101825;6796.048553202556;6827.897581536182;6873.312668733087;6880.552764070319;6656.400923916871;6735.158105236846;6752.155980502437;6753.628550429774;6853.862922741518;4904.852854414374;4929.482404347564;4947.554720075211;4954.603631709455;4983.775730092155;4549.886252843639;4550.112728018004;4561.042181141931;4570.063137056895;4613.492515823256;6236.407541283571;6238.688065596702;6305.527085468517;6318.589291696025;6327.145835312174;6692.83267918306;6787.457003439812;6796.626185559841;6884.931150688429;6890.5521141126665;6015.608985416022;6171.413715697002;6173.722182501798;6178.752849886044;6183.752649893954;5465.453454654582;5479.150731636602;5483.259759932438;5520.972395138079;5550.750216240279;6887.242403335629;7001.404880585105;7069.363757261871;7088.149422069385;7120.750773722895;6828.5220034597105;6873.037774711544;6904.240533541307;6910.136232970879;6910.44716422695;6964.825879353057;7076.646167691698;7155.964220178866;7173.175084865307;7179.425645948207;6582.407583317525;6636.867262654623;6699;6736.32636736342;6742.528023038536;6839.62382068991;6859.794206173823;6870.656467176521;6918.238993710587;6918.5502942308585;6556.0493728408155;6566.8358291043105;6578.276389597237;6659.567128136656;6670.299618539983;6560.376764207393;6592.43964263043;6650.667466626553;6672.833179170365;6679.966600166968;6436.388543088399;6516.804495865132;6519.054737063005;6528.183977002875;6572.539922205399;6566.412798535362;6568.211814582281;6628.83427914306;6663.666816659051;6672.9666351669875;6429.196350456193;6455.709493072917;6456.063870738622;6461.030845373231;6465.2564955030775 04:12:33 INFO - PID 12868 | |1;ext.html;865.8860572665552;935.6210734652468;960.7790208252102;979.2361957673018;987.5555999800088;44314.77842610786;44859.77570112153;45005.32492012622;45014;45140.774296128555;41522.58477415225;41566.58433415672;41576;41735.79132104343;41878.371824422655;7359.337659610634;7466.775996720107;7476.962615186916;7481.738139165131;7492.850142997137;7360.77917662471;7471.439642026842;7473.551586904803;7481.364084052862;7481.8877716834295;7437.107547094356;7470.813229669275;7995.600219989006;8248.422610417274;8264;8148.75553733386;8216.83566328676;8222.301104406133;8224.054233763103;8234.05308389531;7653.464257501977;7715.575643339614;7717.459777815555;7722.961385193094;7948.205179482064;40018;40306;40372.79813600913;40449;40486;3699.35261329269;3755.75587586806;3757.1170774867883;3757.830897609587;3758.605346438639;31598.684013159804;32008.519872201934;32120.196995075075;32806.6719332806;33055.50416743751;5462.317210348707;5485.561155107622;5517.337919449692;5527.668339899619;5527.834164975057;227223;227647;227754;227816;228169;52568;52722.20916686253;52771.20843187355;52782.472175278526;52875.73562132242;55149.44850551443;55481;55493.44506554963;55587;55596;15104.471343502924;15611.531654050397;15656.608584785472;15680.294386752623;15680.686386272439;12615.93692031534;12639.304838233802;12660.240385576895;12669;12684.682882928;14811.481598144013;15213;15246.923765381323;15295.311710973034;15404.691906161814;5900.852478687982;6034.2155519782145;6171.876562468726;6304.306526282106;6330;1058.1746237934424;1084.479449864054;1095.8904109588977;1095.89314792059;1096.6435908329825;23771.52456950886;24002.759972400054;24026;24231.394215144763;24281.271561853173;1181.480148734554;1195.2111606339774;1202.4889421995617;1202.7173614200656;1221.0658845982653;12283.508659653693;12409.565665201675;12557.246565206116;12630.81053784194;12761.553345632858;271161;272485;272554;274078;274179;57389;57602.7119864398;61161.69419152876;61751.6912415444;62253;1502.1963249661378;1523.3906437425119;1528.1213302351193;1543.930523126462;1544.4285614322548;29921.551176732803;30046.84976575103;30229.09312720622;30248.5462718055;30826;41407.37888931729;41431.7928410356;41667.37498937458;41714.79142604268;41876.371854421595;239349;242486;243623;243692;243962;35618.28763424769;35723;35820.820895895355;35896.820515897256;36085;45199;46138.538614613426;46587;46714.766426167655;46884.7655761719;33547.496787547716;33553.32893342168;33763.32473350568;33769.3246135071;33939.66060339365;34267.314653706286;34431.4835277476;34869.47695784616;34966;35315.293694126485;39344.60655393409;40473.79763101166;40510;40604.79697601493;40798.79600601978;33316.66683333136;33347.49978750369;33548;33620.66379336175;33759;24835.25494235176;24990.37524061913;25130.718141339912;26099.347516311485;26229.868850655625 04:12:33 INFO - PID 12868 | |2;jquery.html;585.4701495146892;589.5401586762326;590.4862769390628;599.8860216558853;607.4381197392412;23587;24410.633840492406;24416.023359065617;24445.144419945307;24447.144349947754;23837.28488145354;24689.876550617268;24893.377665558324;24933.127340543084;25506.744932550668;6587.736490540373;6589.967050164766;6653.035309880064;6657.567258128231;6722.932770672304;6473.190851143607;6514.706838192269;6671.432928201109;6737;6738.191417029939;6681.164854393201;6683.799486015403;6689.933100669004;6690.33096690332;6690.464762818963;6399.680015999182;6675.098861653663;6681.599104053772;6685.632290224035;6696.631685257309;6203.7828675996125;6209.87580248397;6210.410011048988;6215.782447614357;6215.96892015537;29673.85163074171;30084.097477075724;30103.849480752455;30107.397852043054;30255;2272.204728345066;2275.5448910218024;2290.931272061841;2307.561563302984;2309.226409152936;20347.79652203474;20604.690929636068;20999.580008399746;21115.73305601669;21139.365819025454;2470.8023358131304;2484.8757562121823;2523.2808649534977;2540.0093963354307;2540.326813394452;141072;147612;154469;161915;162629.18685406615;15004.721765590606;15360.61598460025;15737.606559836096;15997.28012239452;16671.16644167811;24456.144034958692;24568.262952111465;24634.384140396276;24666.13668521593;24794.5041099177;10506.264561480622;10552.15582753378;10629.16328794668;10669.626563070255;10731.409772462433;9549.427034377959;9592.328537002482;9598.136167744937;9659.130678238851;9791.755206119904;9416.293777966679;9703.805923881482;9773.12041916231;9836.606535738634;9909.157721593601;2788.4980703473166;2793.413383189553;2812.3250419899487;2892;2959;1045.7699306152786;1052.1740433759614;1059.189719864289;1065.1159537583787;1072.8444375565655;20618.896905515376;21107.577848443252;21113.26103586367;21204.575908481744;21669.20788861943;1091.6015654286286;1101.0971003776826;1101.5483651702923;1110.4891749795186;1123.4045955643521;11386.94306528462;11518.136139789549;11576.47905844239;11606.941965290289;11707.414629268502;573575;579123;585812;590685;593022;130522;133093;134962;134998;135771;1195.704502805045;1208.5528354508888;1226.1478272600634;1233.5497543396596;1234.4136535145913;18292.72560911561;18388.908055459637;18431.354902578347;18481.630367392845;18562.164702588147;62348.688256558424;62435.687821560605;63441.36558634355;65810.67094664495;66789.66605166942;78422.6078869602;78608.60695696714;79061;79073;79428.60285698765;14886;15137.016093953858;15247.847521524644;15258.465953691568;15273.389064437299;23090.191843285404;23299.88350058239;23398.64902026505;23545.29364119079;23568.52862942766;17599.120043998006;17644.38244661482;17651;17917.104144792967;19724.50688732793;16738.163091845116;16927.915360423118;17026.74459883078;17067;17160.39938602143;19660.115294811483;19730.901345493756;19744.60510789805;20139.899300503403;20147.194112235346;14889.181095039878;15196.924015379853;15205.77191342153;15219.543413697607;15270.465533706267;19079.236830526625;19227.230910763414;19384.515387115436;19402;19531.925744084212 04:12:33 INFO - PID 12868 | |3;mootools.html;1385.314269436629;1423.217230523212;1426.586289975907;1427.0795337007628;1430.8283006039276;16668.16659167043;17182.57043573911;17218.65562688747;17232.396866109688;17238.82761172388;16615.50153495397;16713.415030473934;16768.83231167688;16770.496885093435;16860.325586976538;2794.5668421394716;2912.4175164966987;2914.9271268218254;2916.7958242923005;2917.197770613088;2830.9292267693268;2880.4239152169544;2882.0777351247607;2882.236207405029;2883.639545056868;2721.319670082479;2767.750902418782;2824.6327977363017;2836.5603331483653;2842.6304580404517;2872.210142210898;2910.825350478978;2913.2571194345414;2913.5047042002802;2914.154895080424;2734.3437574981863;2754.820936639112;2763.0467488716363;2779.291280723423;2780.9304767380977;16786.83213167877;17149.657006859918;17164.742528862076;17208.655826883518;17230.48308550733;8482.406231563793;8828.984666763276;8833.734987950373;8834.514101724402;8836.955815220947;5435.864103397407;5532.6680399175775;5596.664200148004;5611.382747897728;5674.375818659985;1924.201456395594;1963.941081767535;2105.9052342644463;2161.6109100361928;2205.4596623827106;30066.398672026655;30152.84923575368;30249.697503025127;30313.393732125234;30339.393212136074;7242.782716518513;7246.891296630555;7355.117385913724;7417.8145546361775;7623.809404764926;18886.716699249522;18939;18948.62102757937;18950.90524547396;18977;8512.65949362031;8655.870161947576;8673.479591224546;8675.522846243517;8687.34844886636;7693.538387696756;7722.6910923563555;7775.339096176888;7816.218378162138;7855;5165.66423182492;5480.588955828329;5483.533899618497;5499.587530935196;5516.172574113915;1618.3526589364349;1629.9511014669579;1640.1307307127242;1647.6375197456541;1663.7504374343946;926.9860952085725;968.8449848024283;970.7427531704104;974.4640447753707;985.6205360936091;8027.2775450209765;8171.591420429074;8332.50004999702;8447.197516235949;8466.872996905051;755.6372940988356;784.8901153838467;795.5584650518902;796.7729197178776;799.9880001799978;4916.434610019822;5319.441458646864;5563.582731295169;5613.494785469327;5662.688552129673;24094.51810963771;24691.87654061718;24869.751302487104;25233.495330093294;25317.240482785546;25105.121320753686;25201.369965751004;25294.873525632254;25330.87334563352;25362;11993.88006119945;12230.571929982409;12412.069094817925;12435.191712538655;12470.625881223577;9016.368854180408;9134.22359099484;9138.771530711785;9277.211437027929;9329.11373419524;21053;21351.359459216248;21491;21517.6772348418;21900.89049554742;22035.66946495772;22106.115755369607;22353.77646223582;22473;22658.43353916165;12171.45228464739;12243.632691019284;12335.444904979477;12369.567065152676;12370.938145309216;15414.614634634223;15429.922850385676;15517.45688900883;15714.371425142866;15723.842761572238;11874.643760687193;12136.33250171249;12372.566960156351;12383.504659813867;12475.688107797378;12158.392080395768;12281.508739650671;12375.566855160387;12481.313527756061;12489.812652810397;9512.809743804946;9711.611535538499;9721.513924303898;9744.317897747089;9808;7548.886766698394;7577.621118944141;7711.614419279126;7791.610419479117;7795.064592248967;8127.268545830903;8183.590820459072;8211.260986511243;8254.463459875089;8339.833203335778 04:12:33 INFO - PID 12868 | |4;prototype.html;546.5381752419206;550.790699534177;575.2349375330809;581.575449921557;586.2232541882007;6212.534059945505;6237.906431403532;6272.372762723725;6283.685815709219;6305.716242769075;6142.692865356726;6166.167567378403;6181.412765787254;6212.720427580758;6221.160143380643;5080.288759573663;5109.105906466372;5114.335136432259;5144.639875208737;5157.123289040854;4875.366202393684;4950.108980383529;5030.849074527751;5054.028928717803;5094.388673359202;4958.776855041532;4962.6774259673;4979.228219625964;5005.849824505271;5029.47190544993;4958.231474121499;4963.627727920384;4980.950190498085;4989.900201995976;5018.121828679967;4541.591256786872;4551.476580193287;4558.703684260512;4564.7032942858605;4572.771361431948;6110.786122485736;6177.84555386119;6224.346443623445;6237.189165408513;6238.344973777779;5755.625884317506;5826.766929322865;5828.475437210629;5854.151148083547;5873.647581145145;6612.305707900649;6649.273797742902;6681.198256209286;6693.966530167367;6706.698198581075;4847.975760121177;5029.446760856339;5043.571296439807;5055;5060.266261392115;6533.542652014361;6790.796276111675;6833.248342682301;6839.931600684029;6962.65186740666;5092.465291144376;5122.974385128051;5165.66423182492;5187.688738675692;5224.50367215114;5182.8963420732125;5258.447862974333;5261.921540991287;5274.103402421598;5285.656432331886;5799.2750906136735;5836.095405212199;5849.239598852122;5872.559558033165;5881.3530511643685;6661.467082633378;6685.6322902240845;6686.966565167143;6705.7652982146365;6731.966340168267;1779.57290250339;1781.9287228510714;1794.2912549543119;1796.6406718656322;1809.837114659687;1233.6221733637117;1270.568006877666;1277.7252890628558;1285.4151361130664;1297.234631567361;6088.695565221721;6132.478739307209;6146.108814221912;6184.350643182401;6223.719932603044;6683.966580167165;6694.430973367318;6728.798136055926;6748.595084294958;6826.24911259761;5849.181114643869;6077.939220607737;6123.571350005457;6166.207782213995;6184.134221209034;3466.2547552276383;3498.632643572439;3518.225990282134;3558.217192217708;3573.874914377984;6939.340762627542;6945.548539344926;6965;6995.93004069963;7080.893786593205;6834.897476537856;6919.827004324932;6926.341997510229;6939.7224111036;7016.614086225204;6967.163940327092;7007.754728584373;7040.683169257293;7096.254893236239;7113.89329160063;6416.037594360697;6712.463002959849;6716.83207919806;6732.932670673231;6807.727690892309;6701.966490167518;6739.393454589111;6750.561213521106;6764.294282287125;6770.390664839991;6995.860082798214;7002.859942801014;7021.648917554204;7028;7076.504644674823;5142.280080788767;5173.92239116406;5192;5201.1678131498775;5216.139337009351;6563.212414510289;6723.9327606725265;6795.38841504267;6840.863182736417;6861.691223895036;6451.129097571956;6526.44525215343;6560.770373036921;6604.339566043357;6614.900776488453;6492.610443373413;6518.2504012037325;6544.28012918569;6589.934100659124;6633.6019838809825;6286.937130628635;6374;6415.166028416276;6452.22573291208;6520.478361731145;6466;6536.869262614816;6608.140941677551;6619.874621314484;6659.567128136656;6340.30256671775;6385.106085148176;6453.45145662624;6499.1551098358805;6499.6425196612745 04:12:33 INFO - PID 12868 | |5;yui.html;945.4374647084991;981.5386768218939;988.8121256961177;997.3816233934959;1022.2588623248143;20791.272305469294;21401.46496337592;21490.140394384205;21495.24766633168;21500.784992150075;19413.12640931158;19756.30852920148;20106.396808095746;20211.696824547642;20331.898340508276;997.8303688372976;1012.6506355307444;1013.7364285285805;1014.4319181258481;1016.095674849381;1048.8898665640113;1070.7430216747964;1084.7396624810067;1088.6081010836092;1089.0470838016736;1144.713821544614;1148.6955956671488;1149.545929357903;1149.695330737351;1150.0512077536025;1142.2860712054965;1147.1109889835445;1149.5114576305036;1155.5839897636845;1155.6533040087982;796.9083555391088;820.4420993724265;828.9917100828975;829.3448175940999;844.9493030418195;21203.25788597407;21381.465463363384;21414.03636836346;21415.250466233763;21437.35687929349;23226.65160022601;23457;23935.640965385533;24033.038678452842;24101.15645952401;18388.356407525673;18442;18444.631107377776;18611.06944652762;18639.068046597615;3928.5482169550583;3953.4662820519147;3954.268460334847;3959.0498280412494;3960.485136932209;167289;167663;168452;169220;172447;17766.46700598984;17921.551961201076;17922.28310867577;18292.725609115874;18303.084845757658;34826;34839.825800870836;35070.649293507246;35823;36042.63957360445;9427.198688111588;9535.809283814286;9587.233021358275;9600.951995239979;9604.279679024101;4639.188142075123;4727.456342520585;4806.639502037361;4832.299316599144;4859.538343857328;6157.784477543354;6225.097360882647;6269.8746025079245;6288.27684816252;6306.49548036156;1174.5947648061406;1194.170051813981;1207.7101495640984;1212.587720175127;1216.2702378572785;688.6763221285987;699.2832346844525;716.6022857314136;720.6108701301239;721.90976127984;11642.53429862796;12154.906058454782;12188;12759.872401276054;13039.152455090389;672.1094549721638;674.2919934069208;677.4884961853769;680.1769858471206;686.660103248885;5631.549476041907;5796.1595568642315;5855.414458554111;5934.643921364732;5944.286685597669;154040.22979885252;155017;155257;156152;156225;138146;139594;140585;143184.28407857893;144001;117637.4118129404;118117;121338;122552.38723806145;123519;10764;10891.237613367306;10967.177461690246;11149.10807135411;11224.382658953837;55789.163162551784;57182.428175719375;57193;57253.427465726476;57435;70431;70643.64678176577;71188.28811711817;72733;73377.6331118341;14307.57077287683;14501.564953051426;14615;14692.485762998243;14713.043652162574;16296.755548666542;16301.918490407472;16459.25933333027;16502.092384918466;16675.583110421852;15666.843331566994;15690.607734806721;15815.288312026216;15862.206889655701;15930.123843188272;14692.559223223321;14703.191324477257;14715.337809798371;15193.392264309305;15229.771553426486;14335.426582936565;14349.210793406462;14365.856341436453;14423.42306307736;14578.927105364406;11446.713832154262;11587.362695051854;11601.361925094201;11661.533538658698;11765.941170294094;12855.742885142432;12863;12899.742005160031;13093.476260949456;13277.913171757707 04:12:33 INFO - PID 12868 | __end_tp_report 04:12:33 INFO - PID 12868 | __start_cc_report 04:12:33 INFO - PID 12868 | _x_x_mozilla_cycle_collect,284 04:12:33 INFO - PID 12868 | __end_cc_report 04:12:33 INFO - PID 12868 | __startTimestamp1505733153158__endTimestamp 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | ------- Summary: start ------- 04:12:33 INFO - PID 12868 | Number of tests: 6 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | [#0] dojo.html Cycles:165 Average:6225.92 Median:6516.80 stddev:874.36 (13.4%) stddev-sans-first:857.50 04:12:33 INFO - PID 12868 | Values: 3882.8 3897.2 3907.2 3917.9 3921.1 6206.4 6268.5 6282.2 6283.7 6287.7 6283.4 6289.2 6344.7 6347.3 6357.8 5618.8 5664.8 5685.2 5744.5 5771.5 5666.7 5736.3 5748.9 5755.1 5757.8 194.3 5533.0 5562.2 5728.5 5734.9 5539.9 5563.7 5629.6 5641.7 5646.4 5566.7 5578.5 5632.1 5645.4 5653.9 6174.4 6176.0 6183.1 6234.9 6263.3 6697.2 6700.2 6793.0 6798.7 6818.2 6726.3 6756.9 6765.3 6838.1 6848.4 6225.3 6270.5 6278.0 6289.6 6308.8 6859.4 6863.5 6945.9 6958.3 6997.8 6514.1 6562.4 6632.0 6666.6 6710.3 6889.8 6914.5 6950.2 6960.7 6977.4 6779.8 6796.0 6827.9 6873.3 6880.6 6656.4 6735.2 6752.2 6753.6 6853.9 4904.9 4929.5 4947.6 4954.6 4983.8 4549.9 4550.1 4561.0 4570.1 4613.5 6236.4 6238.7 6305.5 6318.6 6327.1 6692.8 6787.5 6796.6 6884.9 6890.6 6015.6 6171.4 6173.7 6178.8 6183.8 5465.5 5479.2 5483.3 5521.0 5550.8 6887.2 7001.4 7069.4 7088.1 7120.8 6828.5 6873.0 6904.2 6910.1 6910.4 6964.8 7076.6 7156.0 7173.2 7179.4 6582.4 6636.9 6699.0 6736.3 6742.5 6839.6 6859.8 6870.7 6918.2 6918.6 6556.0 6566.8 6578.3 6659.6 6670.3 6560.4 6592.4 6650.7 6672.8 6680.0 6436.4 6516.8 6519.1 6528.2 6572.5 6566.4 6568.2 6628.8 6663.7 6673.0 6429.2 6455.7 6456.1 6461.0 6465.3 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | [#1] ext.html Cycles:180 Average:42537.55 Median:3727.55 stddev:64626.51 (1733.8%) stddev-sans-first:64732.06 04:12:33 INFO - PID 12868 | Values: 865.9 935.6 960.8 979.2 987.6 44314.8 44859.8 45005.3 45014.0 45140.8 41522.6 41566.6 41576.0 41735.8 41878.4 7359.3 7466.8 7477.0 7481.7 7492.9 7360.8 7471.4 7473.6 7481.4 7481.9 7437.1 7470.8 7995.6 8248.4 8264.0 8148.8 8216.8 8222.3 8224.1 8234.1 7653.5 7715.6 7717.5 7723.0 7948.2 40018.0 40306.0 40372.8 40449.0 40486.0 3699.4 3755.8 3757.1 3757.8 3758.6 31598.7 32008.5 32120.2 32806.7 33055.5 5462.3 5485.6 5517.3 5527.7 5527.8 227223.0 227647.0 227754.0 227816.0 228169.0 52568.0 52722.2 52771.2 52782.5 52875.7 55149.4 55481.0 55493.4 55587.0 55596.0 15104.5 15611.5 15656.6 15680.3 15680.7 12615.9 12639.3 12660.2 12669.0 12684.7 14811.5 15213.0 15246.9 15295.3 15404.7 5900.9 6034.2 6171.9 6304.3 6330.0 1058.2 1084.5 1095.9 1095.9 1096.6 23771.5 24002.8 24026.0 24231.4 24281.3 1181.5 1195.2 1202.5 1202.7 1221.1 12283.5 12409.6 12557.2 12630.8 12761.6 271161.0 272485.0 272554.0 274078.0 274179.0 57389.0 57602.7 61161.7 61751.7 62253.0 1502.2 1523.4 1528.1 1543.9 1544.4 29921.6 30046.8 30229.1 30248.5 30826.0 41407.4 41431.8 41667.4 41714.8 41876.4 239349.0 242486.0 243623.0 243692.0 243962.0 35618.3 35723.0 35820.8 35896.8 36085.0 45199.0 46138.5 46587.0 46714.8 46884.8 33547.5 33553.3 33763.3 33769.3 33939.7 34267.3 34431.5 34869.5 34966.0 35315.3 39344.6 40473.8 40510.0 40604.8 40798.8 33316.7 33347.5 33548.0 33620.7 33759.0 24835.3 24990.4 25130.7 26099.3 26229.9 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | [#2] jquery.html Cycles:180 Average:39132.64 Median:23195.04 stddev:98261.50 (423.6%) stddev-sans-first:98494.53 04:12:33 INFO - PID 12868 | Values: 585.5 589.5 590.5 599.9 607.4 23587.0 24410.6 24416.0 24445.1 24447.1 23837.3 24689.9 24893.4 24933.1 25506.7 6587.7 6590.0 6653.0 6657.6 6722.9 6473.2 6514.7 6671.4 6737.0 6738.2 6681.2 6683.8 6689.9 6690.3 6690.5 6399.7 6675.1 6681.6 6685.6 6696.6 6203.8 6209.9 6210.4 6215.8 6216.0 29673.9 30084.1 30103.8 30107.4 30255.0 2272.2 2275.5 2290.9 2307.6 2309.2 20347.8 20604.7 20999.6 21115.7 21139.4 2470.8 2484.9 2523.3 2540.0 2540.3 141072.0 147612.0 154469.0 161915.0 162629.2 15004.7 15360.6 15737.6 15997.3 16671.2 24456.1 24568.3 24634.4 24666.1 24794.5 10506.3 10552.2 10629.2 10669.6 10731.4 9549.4 9592.3 9598.1 9659.1 9791.8 9416.3 9703.8 9773.1 9836.6 9909.2 2788.5 2793.4 2812.3 2892.0 2959.0 1045.8 1052.2 1059.2 1065.1 1072.8 20618.9 21107.6 21113.3 21204.6 21669.2 1091.6 1101.1 1101.5 1110.5 1123.4 11386.9 11518.1 11576.5 11606.9 11707.4 573575.0 579123.0 585812.0 590685.0 593022.0 130522.0 133093.0 134962.0 134998.0 135771.0 1195.7 1208.6 1226.1 1233.5 1234.4 18292.7 18388.9 18431.4 18481.6 18562.2 62348.7 62435.7 63441.4 65810.7 66789.7 78422.6 78608.6 79061.0 79073.0 79428.6 14886.0 15137.0 15247.8 15258.5 15273.4 23090.2 23299.9 23398.6 23545.3 23568.5 17599.1 17644.4 17651.0 17917.1 19724.5 16738.2 16927.9 17026.7 17067.0 17160.4 19660.1 19730.9 19744.6 20139.9 20147.2 14889.2 15196.9 15205.8 15219.5 15270.5 19079.2 19227.2 19384.5 19402.0 19531.9 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | [#3] mootools.html Cycles:180 Average:10331.78 Median:2839.60 stddev:7729.10 (272.2%) stddev-sans-first:7721.55 04:12:33 INFO - PID 12868 | Values: 1385.3 1423.2 1426.6 1427.1 1430.8 16668.2 17182.6 17218.7 17232.4 17238.8 16615.5 16713.4 16768.8 16770.5 16860.3 2794.6 2912.4 2914.9 2916.8 2917.2 2830.9 2880.4 2882.1 2882.2 2883.6 2721.3 2767.8 2824.6 2836.6 2842.6 2872.2 2910.8 2913.3 2913.5 2914.2 2734.3 2754.8 2763.0 2779.3 2780.9 16786.8 17149.7 17164.7 17208.7 17230.5 8482.4 8829.0 8833.7 8834.5 8837.0 5435.9 5532.7 5596.7 5611.4 5674.4 1924.2 1963.9 2105.9 2161.6 2205.5 30066.4 30152.8 30249.7 30313.4 30339.4 7242.8 7246.9 7355.1 7417.8 7623.8 18886.7 18939.0 18948.6 18950.9 18977.0 8512.7 8655.9 8673.5 8675.5 8687.3 7693.5 7722.7 7775.3 7816.2 7855.0 5165.7 5480.6 5483.5 5499.6 5516.2 1618.4 1630.0 1640.1 1647.6 1663.8 927.0 968.8 970.7 974.5 985.6 8027.3 8171.6 8332.5 8447.2 8466.9 755.6 784.9 795.6 796.8 800.0 4916.4 5319.4 5563.6 5613.5 5662.7 24094.5 24691.9 24869.8 25233.5 25317.2 25105.1 25201.4 25294.9 25330.9 25362.0 11993.9 12230.6 12412.1 12435.2 12470.6 9016.4 9134.2 9138.8 9277.2 9329.1 21053.0 21351.4 21491.0 21517.7 21900.9 22035.7 22106.1 22353.8 22473.0 22658.4 12171.5 12243.6 12335.4 12369.6 12370.9 15414.6 15429.9 15517.5 15714.4 15723.8 11874.6 12136.3 12372.6 12383.5 12475.7 12158.4 12281.5 12375.6 12481.3 12489.8 9512.8 9711.6 9721.5 9744.3 9808.0 7548.9 7577.6 7711.6 7791.6 7795.1 8127.3 8183.6 8211.3 8254.5 8339.8 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | [#4] prototype.html Cycles:180 Average:5626.38 Median:6216.94 stddev:1575.06 (25.3%) stddev-sans-first:1532.64 04:12:33 INFO - PID 12868 | Values: 546.5 550.8 575.2 581.6 586.2 6212.5 6237.9 6272.4 6283.7 6305.7 6142.7 6166.2 6181.4 6212.7 6221.2 5080.3 5109.1 5114.3 5144.6 5157.1 4875.4 4950.1 5030.8 5054.0 5094.4 4958.8 4962.7 4979.2 5005.8 5029.5 4958.2 4963.6 4981.0 4989.9 5018.1 4541.6 4551.5 4558.7 4564.7 4572.8 6110.8 6177.8 6224.3 6237.2 6238.3 5755.6 5826.8 5828.5 5854.2 5873.6 6612.3 6649.3 6681.2 6694.0 6706.7 4848.0 5029.4 5043.6 5055.0 5060.3 6533.5 6790.8 6833.2 6839.9 6962.7 5092.5 5123.0 5165.7 5187.7 5224.5 5182.9 5258.4 5261.9 5274.1 5285.7 5799.3 5836.1 5849.2 5872.6 5881.4 6661.5 6685.6 6687.0 6705.8 6732.0 1779.6 1781.9 1794.3 1796.6 1809.8 1233.6 1270.6 1277.7 1285.4 1297.2 6088.7 6132.5 6146.1 6184.4 6223.7 6684.0 6694.4 6728.8 6748.6 6826.2 5849.2 6077.9 6123.6 6166.2 6184.1 3466.3 3498.6 3518.2 3558.2 3573.9 6939.3 6945.5 6965.0 6995.9 7080.9 6834.9 6919.8 6926.3 6939.7 7016.6 6967.2 7007.8 7040.7 7096.3 7113.9 6416.0 6712.5 6716.8 6732.9 6807.7 6702.0 6739.4 6750.6 6764.3 6770.4 6995.9 7002.9 7021.6 7028.0 7076.5 5142.3 5173.9 5192.0 5201.2 5216.1 6563.2 6723.9 6795.4 6840.9 6861.7 6451.1 6526.4 6560.8 6604.3 6614.9 6492.6 6518.3 6544.3 6589.9 6633.6 6286.9 6374.0 6415.2 6452.2 6520.5 6466.0 6536.9 6608.1 6619.9 6659.6 6340.3 6385.1 6453.5 6499.2 6499.6 04:12:33 INFO - PID 12868 | 04:12:33 INFO - PID 12868 | [#5] yui.html Cycles:180 Average:28784.80 Median:17844.01 stddev:44680.95 (250.4%) stddev-sans-first:44757.39 04:12:33 INFO - PID 12868 | Values: 945.4 981.5 988.8 997.4 1022.3 20791.3 21401.5 21490.1 21495.2 21500.8 19413.1 19756.3 20106.4 20211.7 20331.9 997.8 1012.7 1013.7 1014.4 1016.1 1048.9 1070.7 1084.7 1088.6 1089.0 1144.7 1148.7 1149.5 1149.7 1150.1 1142.3 1147.1 1149.5 1155.6 1155.7 796.9 820.4 829.0 829.3 844.9 21203.3 21381.5 21414.0 21415.3 21437.4 23226.7 23457.0 23935.6 24033.0 24101.2 18388.4 18442.0 18444.6 18611.1 18639.1 3928.5 3953.5 3954.3 3959.0 3960.5 167289.0 167663.0 168452.0 169220.0 172447.0 17766.5 17921.6 17922.3 18292.7 18303.1 34826.0 34839.8 35070.6 35823.0 36042.6 9427.2 9535.8 9587.2 9601.0 9604.3 4639.2 4727.5 4806.6 4832.3 4859.5 6157.8 6225.1 6269.9 6288.3 6306.5 1174.6 1194.2 1207.7 1212.6 1216.3 688.7 699.3 716.6 720.6 721.9 11642.5 12154.9 12188.0 12759.9 13039.2 672.1 674.3 677.5 680.2 686.7 5631.5 5796.2 5855.4 5934.6 5944.3 154040.2 155017.0 155257.0 156152.0 156225.0 138146.0 139594.0 140585.0 143184.3 144001.0 117637.4 118117.0 121338.0 122552.4 123519.0 10764.0 10891.2 10967.2 11149.1 11224.4 55789.2 57182.4 57193.0 57253.4 57435.0 70431.0 70643.6 71188.3 72733.0 73377.6 14307.6 14501.6 14615.0 14692.5 14713.0 16296.8 16301.9 16459.3 16502.1 16675.6 15666.8 15690.6 15815.3 15862.2 15930.1 14692.6 14703.2 14715.3 15193.4 15229.8 14335.4 14349.2 14365.9 14423.4 14578.9 11446.7 11587.4 11601.4 11661.5 11765.9 12855.7 12863.0 12899.7 13093.5 13277.9 04:12:33 INFO - PID 12868 | -------- Summary: end -------- 04:12:33 INFO - PID 12868 | 04:12:33 INFO - TEST-INFO | 12868: exit 0 04:12:33 INFO - TEST-OK | dromaeo_css | took 1107516ms 04:12:33 INFO - TEST-START | kraken 04:12:33 INFO - Initialising browser for kraken test... 04:12:33 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:36223/getInfo.html -profile /tmp/tmp4hlfec/profile 04:12:33 INFO - TEST-INFO | started process 13232 (/builds/slave/test/build/application/firefox/firefox http://localhost:36223/getInfo.html) 04:12:39 INFO - TEST-INFO | 13232: exit 0 04:12:39 INFO - Browser initialized. 04:12:39 INFO - Running cycle 1/1 for kraken test... 04:12:39 INFO - Using env: {'DISPLAY': ':0', 04:12:39 INFO - 'HOME': '/home/cltbld', 04:12:39 INFO - 'JSGC_DISABLE_POISONING': '1', 04:12:39 INFO - 'LANG': 'en_US.UTF-8', 04:12:39 INFO - 'LANGUAGE': 'en_US:en', 04:12:39 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 04:12:39 INFO - 'LOGNAME': 'cltbld', 04:12:39 INFO - 'MAIL': '/var/mail/cltbld', 04:12:39 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:12:39 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:12:39 INFO - 'MOZ_CRASHREPORTER': '1', 04:12:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:39 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 04:12:39 INFO - 'MOZ_NO_REMOTE': '1', 04:12:39 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:12:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:39 INFO - 'NO_EM_RESTART': '1', 04:12:39 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:39 INFO - 'PWD': '/builds/slave/test', 04:12:39 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:12:39 INFO - 'RUST_BACKTRACE': 'full', 04:12:39 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 04:12:39 INFO - 'SHELL': '/bin/bash', 04:12:39 INFO - 'SHLVL': '1', 04:12:39 INFO - 'STYLO_FORCE_DISABLED': '1', 04:12:39 INFO - 'TERM': 'linux', 04:12:39 INFO - 'TMOUT': '86400', 04:12:39 INFO - 'USER': 'cltbld', 04:12:39 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304', 04:12:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:39 INFO - '_': '/tools/buildbot/bin/python'} 04:12:39 INFO - TEST-INFO | started process 13471 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4hlfec/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 04:12:40 INFO - PID 13471 | 04:12:40 INFO - PID 13471 | (/builds/slave/test/build/application/firefox/firefox:13520): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 04:12:40 INFO - PID 13471 | 04:12:50 INFO - PID 13471 | RSS: Main: 147574784 04:12:50 INFO - PID 13471 | 04:12:52 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:36223/tests/kraken/driver.html?testName=audio-beat-detection) 04:12:53 INFO - PID 13471 | RSS: Main: 153096192 04:12:53 INFO - PID 13471 | 04:12:56 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:36223/tests/kraken/driver.html?testName=audio-dft) 04:12:56 INFO - PID 13471 | RSS: Main: 153415680 04:12:56 INFO - PID 13471 | 04:12:59 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:36223/tests/kraken/driver.html?testName=audio-fft) 04:13:00 INFO - PID 13471 | RSS: Main: 149696512 04:13:00 INFO - PID 13471 | 04:13:02 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:36223/tests/kraken/driver.html?testName=audio-oscillator) 04:13:03 INFO - PID 13471 | RSS: Main: 151138304 04:13:03 INFO - PID 13471 | 04:13:05 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:36223/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:13:05 INFO - PID 13471 | RSS: Main: 150958080 04:13:05 INFO - PID 13471 | 04:13:08 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:36223/tests/kraken/driver.html?testName=imaging-darkroom) 04:13:09 INFO - PID 13471 | RSS: Main: 151175168 04:13:09 INFO - PID 13471 | 04:13:12 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:36223/tests/kraken/driver.html?testName=imaging-desaturate) 04:13:13 INFO - PID 13471 | RSS: Main: 151670784 04:13:13 INFO - PID 13471 | 04:13:16 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:36223/tests/kraken/driver.html?testName=json-parse-financial) 04:13:17 INFO - PID 13471 | RSS: Main: 153362432 04:13:17 INFO - PID 13471 | 04:13:18 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:36223/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:13:19 INFO - PID 13471 | RSS: Main: 154075136 04:13:19 INFO - PID 13471 | 04:13:20 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:13:21 INFO - PID 13471 | RSS: Main: 153731072 04:13:21 INFO - PID 13471 | 04:13:23 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:13:23 INFO - PID 13471 | RSS: Main: 150450176 04:13:23 INFO - PID 13471 | 04:13:26 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:13:26 INFO - PID 13471 | RSS: Main: 150933504 04:13:26 INFO - PID 13471 | 04:13:29 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:13:30 INFO - PID 13471 | RSS: Main: 151474176 04:13:30 INFO - PID 13471 | 04:13:31 INFO - PID 13471 | Cycle 1(1): loaded http://localhost:36223/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:36223/tests/kraken/driver.html?testName=ai-astar) 04:13:32 INFO - PID 13471 | RSS: Main: 152776704 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | __start_tp_report 04:13:32 INFO - PID 13471 | _x_x_mozilla_page_load 04:13:32 INFO - PID 13471 | _x_x_mozilla_page_load_details 04:13:32 INFO - PID 13471 | |i|pagename|runs| 04:13:32 INFO - PID 13471 | |0;ai-astar;105;106;108;107;106;107;107;107;107;111 04:13:32 INFO - PID 13471 | |1;audio-beat-detection;112;114;113;113;119;115;113;139;115;115 04:13:32 INFO - PID 13471 | |2;audio-dft;162;161;163;162;163;162;162;162;161;166 04:13:32 INFO - PID 13471 | |3;audio-fft;73;73;75;74;72;73;73;75;74;77 04:13:32 INFO - PID 13471 | |4;audio-oscillator;79;79;78;77;77;78;77;77;78;79 04:13:32 INFO - PID 13471 | |5;imaging-gaussian-blur;114;114;113;114;114;114;114;111;114;114 04:13:32 INFO - PID 13471 | |6;imaging-darkroom;152;150;151;152;153;150;150;150;149;150 04:13:32 INFO - PID 13471 | |7;imaging-desaturate;94;95;93;95;94;93;94;94;100;94 04:13:32 INFO - PID 13471 | |8;json-parse-financial;44;47;50;45;43;46;48;49;44;47 04:13:32 INFO - PID 13471 | |9;json-stringify-tinderbox;38;38;38;38;38;37;38;38;38;38 04:13:32 INFO - PID 13471 | |10;stanford-crypto-aes;70;72;71;72;72;71;72;73;72;77 04:13:32 INFO - PID 13471 | |11;stanford-crypto-ccm;104;102;109;107;113;106;105;105;102;108 04:13:32 INFO - PID 13471 | |12;stanford-crypto-pbkdf2;155;150;149;151;148;151;152;164;148;150 04:13:32 INFO - PID 13471 | |13;stanford-crypto-sha256-iterative;59;58;68;61;61;60;59;59;61;57 04:13:32 INFO - PID 13471 | __end_tp_report 04:13:32 INFO - PID 13471 | __start_cc_report 04:13:32 INFO - PID 13471 | _x_x_mozilla_cycle_collect,738 04:13:32 INFO - PID 13471 | __end_cc_report 04:13:32 INFO - PID 13471 | __startTimestamp1505733212173__endTimestamp 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | ------- Summary: start ------- 04:13:32 INFO - PID 13471 | Number of tests: 14 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#0] ai-astar Cycles:10 Average:107.10 Median:107.00 stddev:1.60 (1.5%) stddev-sans-first:1.50 04:13:32 INFO - PID 13471 | Values: 105.0 106.0 108.0 107.0 106.0 107.0 107.0 107.0 107.0 111.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#1] audio-beat-detection Cycles:10 Average:116.80 Median:115.00 stddev:8.04 (7.0%) stddev-sans-first:8.34 04:13:32 INFO - PID 13471 | Values: 112.0 114.0 113.0 113.0 119.0 115.0 113.0 139.0 115.0 115.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#2] audio-dft Cycles:10 Average:162.40 Median:162.00 stddev:1.43 (0.9%) stddev-sans-first:1.51 04:13:32 INFO - PID 13471 | Values: 162.0 161.0 163.0 162.0 163.0 162.0 162.0 162.0 161.0 166.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#3] audio-fft Cycles:10 Average:73.90 Median:74.00 stddev:1.45 (2.0%) stddev-sans-first:1.50 04:13:32 INFO - PID 13471 | Values: 73.0 73.0 75.0 74.0 72.0 73.0 73.0 75.0 74.0 77.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#4] audio-oscillator Cycles:10 Average:77.90 Median:78.00 stddev:0.88 (1.1%) stddev-sans-first:0.83 04:13:32 INFO - PID 13471 | Values: 79.0 79.0 78.0 77.0 77.0 78.0 77.0 77.0 78.0 79.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#5] imaging-gaussian-blur Cycles:10 Average:113.60 Median:114.00 stddev:0.97 (0.8%) stddev-sans-first:1.01 04:13:32 INFO - PID 13471 | Values: 114.0 114.0 113.0 114.0 114.0 114.0 114.0 111.0 114.0 114.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#6] imaging-darkroom Cycles:10 Average:150.70 Median:150.50 stddev:1.25 (0.8%) stddev-sans-first:1.24 04:13:32 INFO - PID 13471 | Values: 152.0 150.0 151.0 152.0 153.0 150.0 150.0 150.0 149.0 150.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#7] imaging-desaturate Cycles:10 Average:94.60 Median:94.00 stddev:2.01 (2.1%) stddev-sans-first:2.12 04:13:32 INFO - PID 13471 | Values: 94.0 95.0 93.0 95.0 94.0 93.0 94.0 94.0 100.0 94.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#8] json-parse-financial Cycles:10 Average:46.30 Median:47.00 stddev:2.31 (4.9%) stddev-sans-first:2.30 04:13:32 INFO - PID 13471 | Values: 44.0 47.0 50.0 45.0 43.0 46.0 48.0 49.0 44.0 47.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#9] json-stringify-tinderbox Cycles:10 Average:37.90 Median:38.00 stddev:0.32 (0.8%) stddev-sans-first:0.33 04:13:32 INFO - PID 13471 | Values: 38.0 38.0 38.0 38.0 38.0 37.0 38.0 38.0 38.0 38.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#10] stanford-crypto-aes Cycles:10 Average:72.20 Median:72.00 stddev:1.87 (2.6%) stddev-sans-first:1.81 04:13:32 INFO - PID 13471 | Values: 70.0 72.0 71.0 72.0 72.0 71.0 72.0 73.0 72.0 77.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#11] stanford-crypto-ccm Cycles:10 Average:106.10 Median:106.50 stddev:3.35 (3.1%) stddev-sans-first:3.46 04:13:32 INFO - PID 13471 | Values: 104.0 102.0 109.0 107.0 113.0 106.0 105.0 105.0 102.0 108.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:151.80 Median:151.00 stddev:4.76 (3.1%) stddev-sans-first:4.90 04:13:32 INFO - PID 13471 | Values: 155.0 150.0 149.0 151.0 148.0 151.0 152.0 164.0 148.0 150.0 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.30 Median:60.50 stddev:3.02 (5.0%) stddev-sans-first:3.17 04:13:32 INFO - PID 13471 | Values: 59.0 58.0 68.0 61.0 61.0 60.0 59.0 59.0 61.0 57.0 04:13:32 INFO - PID 13471 | -------- Summary: end -------- 04:13:32 INFO - PID 13471 | 04:13:32 INFO - PID 13471 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 04:13:32 INFO - TEST-INFO | 13471: exit 0 04:13:32 INFO - TEST-OK | kraken | took 59097ms 04:13:32 INFO - SUITE-END | took 1166s 04:13:32 INFO - Completed test suite (00:19:26) 04:13:32 INFO - javascript benchmark 04:13:32 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s", "stylo_disabled"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8956.920961449545, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3882.825272862721, 3897.220555888823, 3907.1794923066154, 3917.902052448687, 3921.0785465415624, 6206.379362063792, 6268.498520118391, 6282.246130464345, 6283.748650053998, 6287.748490060392, 6283.4030767077165, 6289.213848268966, 6344.651044192579, 6347.30179680236, 6357.841053973653, 5618.775248990036, 5664.801731939373, 5685.1756495308155, 5744.4829965303115, 5771.50942169916, 5666.716664166795, 5736.2542869427125, 5748.942510574903, 5755.079187330028, 5757.798477053304, 194.27676986017124, 5533.031719449121, 5562.193481945135, 5728.484436400723, 5734.942650573504, 5539.861503462405, 5563.721813909288, 5629.57778166635, 5641.661500309953, 5646.378898321182, 5566.666000040011, 5578.470045345726, 5632.07070833312, 5645.379008309083, 5653.886922261573, 6174.413430724074, 6176.0, 6183.134361189437, 6234.875302493925, 6263.34234905333, 6697.151945921736, 6700.195976482804, 6793.0, 6798.728050877959, 6818.249992500821, 6726.260111387744, 6756.864862702768, 6765.289644587297, 6838.14523184602, 6848.383645471881, 6225.284092329395, 6270.529710271702, 6277.968610156966, 6289.559730818844, 6308.779192728279, 6859.416949559243, 6863.519553631298, 6945.89581156283, 6958.269381714948, 6997.825054373681, 6514.120593719787, 6562.376574225441, 6632.0, 6666.600003999775, 6710.295418981034, 6889.758858439931, 6914.51598388108, 6950.165980082423, 6960.65196740161, 6977.441804655616, 6779.796606101825, 6796.048553202556, 6827.897581536182, 6873.312668733087, 6880.552764070319, 6656.400923916871, 6735.158105236846, 6752.155980502437, 6753.628550429774, 6853.862922741518, 4904.852854414374, 4929.482404347564, 4947.554720075211, 4954.603631709455, 4983.775730092155, 4549.886252843639, 4550.112728018004, 4561.042181141931, 4570.063137056895, 4613.492515823256, 6236.407541283571, 6238.688065596702, 6305.527085468517, 6318.589291696025, 6327.145835312174, 6692.83267918306, 6787.457003439812, 6796.626185559841, 6884.931150688429, 6890.5521141126665, 6015.608985416022, 6171.413715697002, 6173.722182501798, 6178.752849886044, 6183.752649893954, 5465.453454654582, 5479.150731636602, 5483.259759932438, 5520.972395138079, 5550.750216240279, 6887.242403335629, 7001.404880585105, 7069.363757261871, 7088.149422069385, 7120.750773722895, 6828.5220034597105, 6873.037774711544, 6904.240533541307, 6910.136232970879, 6910.44716422695, 6964.825879353057, 7076.646167691698, 7155.964220178866, 7173.175084865307, 7179.425645948207, 6582.407583317525, 6636.867262654623, 6699.0, 6736.32636736342, 6742.528023038536, 6839.62382068991, 6859.794206173823, 6870.656467176521, 6918.238993710587, 6918.5502942308585, 6556.0493728408155, 6566.8358291043105, 6578.276389597237, 6659.567128136656, 6670.299618539983, 6560.376764207393, 6592.43964263043, 6650.667466626553, 6672.833179170365, 6679.966600166968, 6436.388543088399, 6516.804495865132, 6519.054737063005, 6528.183977002875, 6572.539922205399, 6566.412798535362, 6568.211814582281, 6628.83427914306, 6663.666816659051, 6672.9666351669875, 6429.196350456193, 6455.709493072917, 6456.063870738622, 6461.030845373231, 6465.2564955030775], "value": 6169.251245711102, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [865.8860572665552, 935.6210734652468, 960.7790208252102, 979.2361957673018, 987.5555999800088, 44314.77842610786, 44859.77570112153, 45005.32492012622, 45014.0, 45140.774296128555, 41522.58477415225, 41566.58433415672, 41576.0, 41735.79132104343, 41878.371824422655, 7359.337659610634, 7466.775996720107, 7476.962615186916, 7481.738139165131, 7492.850142997137, 7360.77917662471, 7471.439642026842, 7473.551586904803, 7481.364084052862, 7481.8877716834295, 7437.107547094356, 7470.813229669275, 7995.600219989006, 8248.422610417274, 8264.0, 8148.75553733386, 8216.83566328676, 8222.301104406133, 8224.054233763103, 8234.05308389531, 7653.464257501977, 7715.575643339614, 7717.459777815555, 7722.961385193094, 7948.205179482064, 40018.0, 40306.0, 40372.79813600913, 40449.0, 40486.0, 3699.35261329269, 3755.75587586806, 3757.1170774867883, 3757.830897609587, 3758.605346438639, 31598.684013159804, 32008.519872201934, 32120.196995075075, 32806.6719332806, 33055.50416743751, 5462.317210348707, 5485.561155107622, 5517.337919449692, 5527.668339899619, 5527.834164975057, 227223.0, 227647.0, 227754.0, 227816.0, 228169.0, 52568.0, 52722.20916686253, 52771.20843187355, 52782.472175278526, 52875.73562132242, 55149.44850551443, 55481.0, 55493.44506554963, 55587.0, 55596.0, 15104.471343502924, 15611.531654050397, 15656.608584785472, 15680.294386752623, 15680.686386272439, 12615.93692031534, 12639.304838233802, 12660.240385576895, 12669.0, 12684.682882928, 14811.481598144013, 15213.0, 15246.923765381323, 15295.311710973034, 15404.691906161814, 5900.852478687982, 6034.2155519782145, 6171.876562468726, 6304.306526282106, 6330.0, 1058.1746237934424, 1084.479449864054, 1095.8904109588977, 1095.89314792059, 1096.6435908329825, 23771.52456950886, 24002.759972400054, 24026.0, 24231.394215144763, 24281.271561853173, 1181.480148734554, 1195.2111606339774, 1202.4889421995617, 1202.7173614200656, 1221.0658845982653, 12283.508659653693, 12409.565665201675, 12557.246565206116, 12630.81053784194, 12761.553345632858, 271161.0, 272485.0, 272554.0, 274078.0, 274179.0, 57389.0, 57602.7119864398, 61161.69419152876, 61751.6912415444, 62253.0, 1502.1963249661378, 1523.3906437425119, 1528.1213302351193, 1543.930523126462, 1544.4285614322548, 29921.551176732803, 30046.84976575103, 30229.09312720622, 30248.5462718055, 30826.0, 41407.37888931729, 41431.7928410356, 41667.37498937458, 41714.79142604268, 41876.371854421595, 239349.0, 242486.0, 243623.0, 243692.0, 243962.0, 35618.28763424769, 35723.0, 35820.820895895355, 35896.820515897256, 36085.0, 45199.0, 46138.538614613426, 46587.0, 46714.766426167655, 46884.7655761719, 33547.496787547716, 33553.32893342168, 33763.32473350568, 33769.3246135071, 33939.66060339365, 34267.314653706286, 34431.4835277476, 34869.47695784616, 34966.0, 35315.293694126485, 39344.60655393409, 40473.79763101166, 40510.0, 40604.79697601493, 40798.79600601978, 33316.66683333136, 33347.49978750369, 33548.0, 33620.66379336175, 33759.0, 24835.25494235176, 24990.37524061913, 25130.718141339912, 26099.347516311485, 26229.868850655625], "value": 18378.618322107894, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [585.4701495146892, 589.5401586762326, 590.4862769390628, 599.8860216558853, 607.4381197392412, 23587.0, 24410.633840492406, 24416.023359065617, 24445.144419945307, 24447.144349947754, 23837.28488145354, 24689.876550617268, 24893.377665558324, 24933.127340543084, 25506.744932550668, 6587.736490540373, 6589.967050164766, 6653.035309880064, 6657.567258128231, 6722.932770672304, 6473.190851143607, 6514.706838192269, 6671.432928201109, 6737.0, 6738.191417029939, 6681.164854393201, 6683.799486015403, 6689.933100669004, 6690.33096690332, 6690.464762818963, 6399.680015999182, 6675.098861653663, 6681.599104053772, 6685.632290224035, 6696.631685257309, 6203.7828675996125, 6209.87580248397, 6210.410011048988, 6215.782447614357, 6215.96892015537, 29673.85163074171, 30084.097477075724, 30103.849480752455, 30107.397852043054, 30255.0, 2272.204728345066, 2275.5448910218024, 2290.931272061841, 2307.561563302984, 2309.226409152936, 20347.79652203474, 20604.690929636068, 20999.580008399746, 21115.73305601669, 21139.365819025454, 2470.8023358131304, 2484.8757562121823, 2523.2808649534977, 2540.0093963354307, 2540.326813394452, 141072.0, 147612.0, 154469.0, 161915.0, 162629.18685406615, 15004.721765590606, 15360.61598460025, 15737.606559836096, 15997.28012239452, 16671.16644167811, 24456.144034958692, 24568.262952111465, 24634.384140396276, 24666.13668521593, 24794.5041099177, 10506.264561480622, 10552.15582753378, 10629.16328794668, 10669.626563070255, 10731.409772462433, 9549.427034377959, 9592.328537002482, 9598.136167744937, 9659.130678238851, 9791.755206119904, 9416.293777966679, 9703.805923881482, 9773.12041916231, 9836.606535738634, 9909.157721593601, 2788.4980703473166, 2793.413383189553, 2812.3250419899487, 2892.0, 2959.0, 1045.7699306152786, 1052.1740433759614, 1059.189719864289, 1065.1159537583787, 1072.8444375565655, 20618.896905515376, 21107.577848443252, 21113.26103586367, 21204.575908481744, 21669.20788861943, 1091.6015654286286, 1101.0971003776826, 1101.5483651702923, 1110.4891749795186, 1123.4045955643521, 11386.94306528462, 11518.136139789549, 11576.47905844239, 11606.941965290289, 11707.414629268502, 573575.0, 579123.0, 585812.0, 590685.0, 593022.0, 130522.0, 133093.0, 134962.0, 134998.0, 135771.0, 1195.704502805045, 1208.5528354508888, 1226.1478272600634, 1233.5497543396596, 1234.4136535145913, 18292.72560911561, 18388.908055459637, 18431.354902578347, 18481.630367392845, 18562.164702588147, 62348.688256558424, 62435.687821560605, 63441.36558634355, 65810.67094664495, 66789.66605166942, 78422.6078869602, 78608.60695696714, 79061.0, 79073.0, 79428.60285698765, 14886.0, 15137.016093953858, 15247.847521524644, 15258.465953691568, 15273.389064437299, 23090.191843285404, 23299.88350058239, 23398.64902026505, 23545.29364119079, 23568.52862942766, 17599.120043998006, 17644.38244661482, 17651.0, 17917.104144792967, 19724.50688732793, 16738.163091845116, 16927.915360423118, 17026.74459883078, 17067.0, 17160.39938602143, 19660.115294811483, 19730.901345493756, 19744.60510789805, 20139.899300503403, 20147.194112235346, 14889.181095039878, 15196.924015379853, 15205.77191342153, 15219.543413697607, 15270.465533706267, 19079.236830526625, 19227.230910763414, 19384.515387115436, 19402.0, 19531.925744084212], "value": 12614.995524655853, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1385.314269436629, 1423.217230523212, 1426.586289975907, 1427.0795337007628, 1430.8283006039276, 16668.16659167043, 17182.57043573911, 17218.65562688747, 17232.396866109688, 17238.82761172388, 16615.50153495397, 16713.415030473934, 16768.83231167688, 16770.496885093435, 16860.325586976538, 2794.5668421394716, 2912.4175164966987, 2914.9271268218254, 2916.7958242923005, 2917.197770613088, 2830.9292267693268, 2880.4239152169544, 2882.0777351247607, 2882.236207405029, 2883.639545056868, 2721.319670082479, 2767.750902418782, 2824.6327977363017, 2836.5603331483653, 2842.6304580404517, 2872.210142210898, 2910.825350478978, 2913.2571194345414, 2913.5047042002802, 2914.154895080424, 2734.3437574981863, 2754.820936639112, 2763.0467488716363, 2779.291280723423, 2780.9304767380977, 16786.83213167877, 17149.657006859918, 17164.742528862076, 17208.655826883518, 17230.48308550733, 8482.406231563793, 8828.984666763276, 8833.734987950373, 8834.514101724402, 8836.955815220947, 5435.864103397407, 5532.6680399175775, 5596.664200148004, 5611.382747897728, 5674.375818659985, 1924.201456395594, 1963.941081767535, 2105.9052342644463, 2161.6109100361928, 2205.4596623827106, 30066.398672026655, 30152.84923575368, 30249.697503025127, 30313.393732125234, 30339.393212136074, 7242.782716518513, 7246.891296630555, 7355.117385913724, 7417.8145546361775, 7623.809404764926, 18886.716699249522, 18939.0, 18948.62102757937, 18950.90524547396, 18977.0, 8512.65949362031, 8655.870161947576, 8673.479591224546, 8675.522846243517, 8687.34844886636, 7693.538387696756, 7722.6910923563555, 7775.339096176888, 7816.218378162138, 7855.0, 5165.66423182492, 5480.588955828329, 5483.533899618497, 5499.587530935196, 5516.172574113915, 1618.3526589364349, 1629.9511014669579, 1640.1307307127242, 1647.6375197456541, 1663.7504374343946, 926.9860952085725, 968.8449848024283, 970.7427531704104, 974.4640447753707, 985.6205360936091, 8027.2775450209765, 8171.591420429074, 8332.50004999702, 8447.197516235949, 8466.872996905051, 755.6372940988356, 784.8901153838467, 795.5584650518902, 796.7729197178776, 799.9880001799978, 4916.434610019822, 5319.441458646864, 5563.582731295169, 5613.494785469327, 5662.688552129673, 24094.51810963771, 24691.87654061718, 24869.751302487104, 25233.495330093294, 25317.240482785546, 25105.121320753686, 25201.369965751004, 25294.873525632254, 25330.87334563352, 25362.0, 11993.88006119945, 12230.571929982409, 12412.069094817925, 12435.191712538655, 12470.625881223577, 9016.368854180408, 9134.22359099484, 9138.771530711785, 9277.211437027929, 9329.11373419524, 21053.0, 21351.359459216248, 21491.0, 21517.6772348418, 21900.89049554742, 22035.66946495772, 22106.115755369607, 22353.77646223582, 22473.0, 22658.43353916165, 12171.45228464739, 12243.632691019284, 12335.444904979477, 12369.567065152676, 12370.938145309216, 15414.614634634223, 15429.922850385676, 15517.45688900883, 15714.371425142866, 15723.842761572238, 11874.643760687193, 12136.33250171249, 12372.566960156351, 12383.504659813867, 12475.688107797378, 12158.392080395768, 12281.508739650671, 12375.566855160387, 12481.313527756061, 12489.812652810397, 9512.809743804946, 9711.611535538499, 9721.513924303898, 9744.317897747089, 9808.0, 7548.886766698394, 7577.621118944141, 7711.614419279126, 7791.610419479117, 7795.064592248967, 8127.268545830903, 8183.590820459072, 8211.260986511243, 8254.463459875089, 8339.833203335778], "value": 7186.402796920417, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [546.5381752419206, 550.790699534177, 575.2349375330809, 581.575449921557, 586.2232541882007, 6212.534059945505, 6237.906431403532, 6272.372762723725, 6283.685815709219, 6305.716242769075, 6142.692865356726, 6166.167567378403, 6181.412765787254, 6212.720427580758, 6221.160143380643, 5080.288759573663, 5109.105906466372, 5114.335136432259, 5144.639875208737, 5157.123289040854, 4875.366202393684, 4950.108980383529, 5030.849074527751, 5054.028928717803, 5094.388673359202, 4958.776855041532, 4962.6774259673, 4979.228219625964, 5005.849824505271, 5029.47190544993, 4958.231474121499, 4963.627727920384, 4980.950190498085, 4989.900201995976, 5018.121828679967, 4541.591256786872, 4551.476580193287, 4558.703684260512, 4564.7032942858605, 4572.771361431948, 6110.786122485736, 6177.84555386119, 6224.346443623445, 6237.189165408513, 6238.344973777779, 5755.625884317506, 5826.766929322865, 5828.475437210629, 5854.151148083547, 5873.647581145145, 6612.305707900649, 6649.273797742902, 6681.198256209286, 6693.966530167367, 6706.698198581075, 4847.975760121177, 5029.446760856339, 5043.571296439807, 5055.0, 5060.266261392115, 6533.542652014361, 6790.796276111675, 6833.248342682301, 6839.931600684029, 6962.65186740666, 5092.465291144376, 5122.974385128051, 5165.66423182492, 5187.688738675692, 5224.50367215114, 5182.8963420732125, 5258.447862974333, 5261.921540991287, 5274.103402421598, 5285.656432331886, 5799.2750906136735, 5836.095405212199, 5849.239598852122, 5872.559558033165, 5881.3530511643685, 6661.467082633378, 6685.6322902240845, 6686.966565167143, 6705.7652982146365, 6731.966340168267, 1779.57290250339, 1781.9287228510714, 1794.2912549543119, 1796.6406718656322, 1809.837114659687, 1233.6221733637117, 1270.568006877666, 1277.7252890628558, 1285.4151361130664, 1297.234631567361, 6088.695565221721, 6132.478739307209, 6146.108814221912, 6184.350643182401, 6223.719932603044, 6683.966580167165, 6694.430973367318, 6728.798136055926, 6748.595084294958, 6826.24911259761, 5849.181114643869, 6077.939220607737, 6123.571350005457, 6166.207782213995, 6184.134221209034, 3466.2547552276383, 3498.632643572439, 3518.225990282134, 3558.217192217708, 3573.874914377984, 6939.340762627542, 6945.548539344926, 6965.0, 6995.93004069963, 7080.893786593205, 6834.897476537856, 6919.827004324932, 6926.341997510229, 6939.7224111036, 7016.614086225204, 6967.163940327092, 7007.754728584373, 7040.683169257293, 7096.254893236239, 7113.89329160063, 6416.037594360697, 6712.463002959849, 6716.83207919806, 6732.932670673231, 6807.727690892309, 6701.966490167518, 6739.393454589111, 6750.561213521106, 6764.294282287125, 6770.390664839991, 6995.860082798214, 7002.859942801014, 7021.648917554204, 7028.0, 7076.504644674823, 5142.280080788767, 5173.92239116406, 5192.0, 5201.1678131498775, 5216.139337009351, 6563.212414510289, 6723.9327606725265, 6795.38841504267, 6840.863182736417, 6861.691223895036, 6451.129097571956, 6526.44525215343, 6560.770373036921, 6604.339566043357, 6614.900776488453, 6492.610443373413, 6518.2504012037325, 6544.28012918569, 6589.934100659124, 6633.6019838809825, 6286.937130628635, 6374.0, 6415.166028416276, 6452.22573291208, 6520.478361731145, 6466.0, 6536.869262614816, 6608.140941677551, 6619.874621314484, 6659.567128136656, 6340.30256671775, 6385.106085148176, 6453.45145662624, 6499.1551098358805, 6499.6425196612745], "value": 5173.190357106853, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [945.4374647084991, 981.5386768218939, 988.8121256961177, 997.3816233934959, 1022.2588623248143, 20791.272305469294, 21401.46496337592, 21490.140394384205, 21495.24766633168, 21500.784992150075, 19413.12640931158, 19756.30852920148, 20106.396808095746, 20211.696824547642, 20331.898340508276, 997.8303688372976, 1012.6506355307444, 1013.7364285285805, 1014.4319181258481, 1016.095674849381, 1048.8898665640113, 1070.7430216747964, 1084.7396624810067, 1088.6081010836092, 1089.0470838016736, 1144.713821544614, 1148.6955956671488, 1149.545929357903, 1149.695330737351, 1150.0512077536025, 1142.2860712054965, 1147.1109889835445, 1149.5114576305036, 1155.5839897636845, 1155.6533040087982, 796.9083555391088, 820.4420993724265, 828.9917100828975, 829.3448175940999, 844.9493030418195, 21203.25788597407, 21381.465463363384, 21414.03636836346, 21415.250466233763, 21437.35687929349, 23226.65160022601, 23457.0, 23935.640965385533, 24033.038678452842, 24101.15645952401, 18388.356407525673, 18442.0, 18444.631107377776, 18611.06944652762, 18639.068046597615, 3928.5482169550583, 3953.4662820519147, 3954.268460334847, 3959.0498280412494, 3960.485136932209, 167289.0, 167663.0, 168452.0, 169220.0, 172447.0, 17766.46700598984, 17921.551961201076, 17922.28310867577, 18292.725609115874, 18303.084845757658, 34826.0, 34839.825800870836, 35070.649293507246, 35823.0, 36042.63957360445, 9427.198688111588, 9535.809283814286, 9587.233021358275, 9600.951995239979, 9604.279679024101, 4639.188142075123, 4727.456342520585, 4806.639502037361, 4832.299316599144, 4859.538343857328, 6157.784477543354, 6225.097360882647, 6269.8746025079245, 6288.27684816252, 6306.49548036156, 1174.5947648061406, 1194.170051813981, 1207.7101495640984, 1212.587720175127, 1216.2702378572785, 688.6763221285987, 699.2832346844525, 716.6022857314136, 720.6108701301239, 721.90976127984, 11642.53429862796, 12154.906058454782, 12188.0, 12759.872401276054, 13039.152455090389, 672.1094549721638, 674.2919934069208, 677.4884961853769, 680.1769858471206, 686.660103248885, 5631.549476041907, 5796.1595568642315, 5855.414458554111, 5934.643921364732, 5944.286685597669, 154040.22979885252, 155017.0, 155257.0, 156152.0, 156225.0, 138146.0, 139594.0, 140585.0, 143184.28407857893, 144001.0, 117637.4118129404, 118117.0, 121338.0, 122552.38723806145, 123519.0, 10764.0, 10891.237613367306, 10967.177461690246, 11149.10807135411, 11224.382658953837, 55789.163162551784, 57182.428175719375, 57193.0, 57253.427465726476, 57435.0, 70431.0, 70643.64678176577, 71188.28811711817, 72733.0, 73377.6331118341, 14307.57077287683, 14501.564953051426, 14615.0, 14692.485762998243, 14713.043652162574, 16296.755548666542, 16301.918490407472, 16459.25933333027, 16502.092384918466, 16675.583110421852, 15666.843331566994, 15690.607734806721, 15815.288312026216, 15862.206889655701, 15930.123843188272, 14692.559223223321, 14703.191324477257, 14715.337809798371, 15193.392264309305, 15229.771553426486, 14335.426582936565, 14349.210793406462, 14365.856341436453, 14423.42306307736, 14578.927105364406, 11446.713832154262, 11587.362695051854, 11601.361925094201, 11661.533538658698, 11765.941170294094, 12855.742885142432, 12863.0, 12899.742005160031, 13093.476260949456, 13277.913171757707], "value": 9710.092874671256, "unit": "score"}]}, {"extraOptions": ["e10s", "stylo_disabled"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1371.5999999999997, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 106.0, 108.0, 107.0, 106.0, 107.0, 107.0, 107.0, 107.0, 111.0], "value": 107.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 114.0, 113.0, 113.0, 119.0, 115.0, 113.0, 139.0, 115.0, 115.0], "value": 116.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 161.0, 163.0, 162.0, 163.0, 162.0, 162.0, 162.0, 161.0, 166.0], "value": 162.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 73.0, 75.0, 74.0, 72.0, 73.0, 73.0, 75.0, 74.0, 77.0], "value": 73.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 79.0, 78.0, 77.0, 77.0, 78.0, 77.0, 77.0, 78.0, 79.0], "value": 77.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 113.0, 114.0, 114.0, 114.0, 114.0, 111.0, 114.0, 114.0], "value": 113.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 150.0, 151.0, 152.0, 153.0, 150.0, 150.0, 150.0, 149.0, 150.0], "value": 150.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 93.0, 95.0, 94.0, 93.0, 94.0, 94.0, 100.0, 94.0], "value": 94.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [44.0, 47.0, 50.0, 45.0, 43.0, 46.0, 48.0, 49.0, 44.0, 47.0], "value": 46.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [38.0, 38.0, 38.0, 38.0, 38.0, 37.0, 38.0, 38.0, 38.0, 38.0], "value": 37.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 72.0, 71.0, 72.0, 72.0, 71.0, 72.0, 73.0, 72.0, 77.0], "value": 72.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 102.0, 109.0, 107.0, 113.0, 106.0, 105.0, 105.0, 102.0, 108.0], "value": 106.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 150.0, 149.0, 151.0, 148.0, 151.0, 152.0, 164.0, 148.0, 150.0], "value": 151.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 58.0, 68.0, 61.0, 61.0, 60.0, 59.0, 59.0, 61.0, 57.0], "value": 60.3, "unit": "score"}]}]} 04:13:32 INFO - Return code: 0 04:13:32 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:13:32 INFO - # TBPL SUCCESS # 04:13:32 INFO - Running post-action listener: _package_coverage_data 04:13:32 INFO - Running post-action listener: _resource_record_post_action 04:13:32 INFO - [mozharness: 2017-09-18 11:13:32.977520Z] Finished run-tests step (success) 04:13:32 INFO - Running post-run listener: _resource_record_post_run 04:13:33 INFO - Total resource usage - Wall time: 1185s; CPU: 13.0%; Read bytes: 4096; Write bytes: 328650752; Read time: 168; Write time: 220276 04:13:33 INFO - TinderboxPrint: CPU usage
13.1% 04:13:33 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 168 04:13:33 INFO - TinderboxPrint: I/O write bytes / time
328,650,752 / 220,276 04:13:33 INFO - TinderboxPrint: CPU idle
8,214.7 (86.9%) 04:13:33 INFO - TinderboxPrint: CPU user
1,186.8 (12.6%) 04:13:33 INFO - TinderboxPrint: Swap in / out
0 / 0 04:13:33 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 9207808; Read time: 0; Write time: 768 04:13:33 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 04:13:33 INFO - run-tests - Wall time: 1167s; CPU: 13.0%; Read bytes: 4096; Write bytes: 318418944; Read time: 168; Write time: 219480 04:13:33 INFO - Running post-run listener: _upload_blobber_files 04:13:33 INFO - Blob upload gear active. 04:13:33 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:13:33 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 04:13:33 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'] 04:13:33 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 04:13:34 INFO - (blobuploader) - INFO - Open directory for files ... 04:13:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log ... 04:13:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:13:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:13:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_errorsummary.log: uploaded 04:13:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:13:34 INFO - (blobuploader) - INFO - Done attempting. 04:13:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log ... 04:13:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:13:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:13:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_raw.log: uploaded 04:13:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:13:35 INFO - (blobuploader) - INFO - Done attempting. 04:13:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:13:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:13:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:13:43 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:13:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:13:43 INFO - (blobuploader) - INFO - Done attempting. 04:13:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 04:13:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:13:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:13:44 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 04:13:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:13:44 INFO - (blobuploader) - INFO - Done attempting. 04:13:44 INFO - (blobuploader) - INFO - Iteration through files over. 04:13:44 INFO - Return code: 0 04:13:44 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:13:44 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:13:44 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d205b26d452900f206bf590b99bcade3df4c57fe15a19f816701cb7f635bd84e5f4f865160c7493bf7989faa4eea69427cf03deb505f75c20b0197b363ab93d9", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bcae2f6d5bbabffd707eb6fc8faeb763b759f0b327d5baf6cddfaaccb86dcefe866c342970bcb3e85bf44282e27839a4cd3ad3c8b44624ddeaffa8ce68c6ed09", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/09036e5b195acdf6bf4cd7150e114cc28dd0588336c6c7046980e787347c579b2fc872f30979f860bb81f88eec0b24ba43a52353ac705b44213477734321499c", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3fb244d19541538a9726bf514145503eebe4e911b14a0b497ae19ec1783b847b9aee239d086ec14ee05c9b9d708e1efae6d289e8369ea0bb37a9c3fddc49cd66"} 04:13:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:13:44 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:13:44 INFO - Contents: 04:13:44 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d205b26d452900f206bf590b99bcade3df4c57fe15a19f816701cb7f635bd84e5f4f865160c7493bf7989faa4eea69427cf03deb505f75c20b0197b363ab93d9", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bcae2f6d5bbabffd707eb6fc8faeb763b759f0b327d5baf6cddfaaccb86dcefe866c342970bcb3e85bf44282e27839a4cd3ad3c8b44624ddeaffa8ce68c6ed09", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/09036e5b195acdf6bf4cd7150e114cc28dd0588336c6c7046980e787347c579b2fc872f30979f860bb81f88eec0b24ba43a52353ac705b44213477734321499c", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3fb244d19541538a9726bf514145503eebe4e911b14a0b497ae19ec1783b847b9aee239d086ec14ee05c9b9d708e1efae6d289e8369ea0bb37a9c3fddc49cd66"} 04:13:44 INFO - Running post-run listener: copy_logs_to_upload_dir 04:13:44 INFO - Copying logs to upload dir... 04:13:44 INFO - mkdir: /builds/slave/test/build/upload/logs 04:13:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.537337 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2017-09-18 04:13:44.450793) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-18 04:13:44.458498) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d205b26d452900f206bf590b99bcade3df4c57fe15a19f816701cb7f635bd84e5f4f865160c7493bf7989faa4eea69427cf03deb505f75c20b0197b363ab93d9", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bcae2f6d5bbabffd707eb6fc8faeb763b759f0b327d5baf6cddfaaccb86dcefe866c342970bcb3e85bf44282e27839a4cd3ad3c8b44624ddeaffa8ce68c6ed09", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/09036e5b195acdf6bf4cd7150e114cc28dd0588336c6c7046980e787347c579b2fc872f30979f860bb81f88eec0b24ba43a52353ac705b44213477734321499c", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3fb244d19541538a9726bf514145503eebe4e911b14a0b497ae19ec1783b847b9aee239d086ec14ee05c9b9d708e1efae6d289e8369ea0bb37a9c3fddc49cd66"} build_url:https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011293 build_url: 'https://queue.taskcluster.net/v1/task/dezH6ewTQambwBP3-fZqzg/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d205b26d452900f206bf590b99bcade3df4c57fe15a19f816701cb7f635bd84e5f4f865160c7493bf7989faa4eea69427cf03deb505f75c20b0197b363ab93d9", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/bcae2f6d5bbabffd707eb6fc8faeb763b759f0b327d5baf6cddfaaccb86dcefe866c342970bcb3e85bf44282e27839a4cd3ad3c8b44624ddeaffa8ce68c6ed09", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/09036e5b195acdf6bf4cd7150e114cc28dd0588336c6c7046980e787347c579b2fc872f30979f860bb81f88eec0b24ba43a52353ac705b44213477734321499c", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3fb244d19541538a9726bf514145503eebe4e911b14a0b497ae19ec1783b847b9aee239d086ec14ee05c9b9d708e1efae6d289e8369ea0bb37a9c3fddc49cd66"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-18 04:13:44.486139) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 04:13:44.486426) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1505731952.453410-1207464304 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004558 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-18 04:13:44.571802) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-18 04:13:44.575110) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-18 04:13:44.575406) ========= ========= Total master_lag: 0.18 =========