builder: mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s slave: talos-linux64-ix-062 starttime: 1502669503.55 results: success (0) revision: e594b178728bc6a51fc81bffcb1d6f0a7071cd33 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.547088) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.547558) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.547873) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.574872) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.575261) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-08-13 17:11:44-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.0M=0s 2017-08-13 17:11:44 (46.0 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.313017 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.915563) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.915882) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023753 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:43.989847) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 11 secs) (at 2017-08-13 17:11:43.990323) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev e594b178728bc6a51fc81bffcb1d6f0a7071cd33 --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 e594b178728bc6a51fc81bffcb1d6f0a7071cd33 --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=a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-08-13 17:11:45,026 truncating revision to first 12 chars 2017-08-13 17:11:45,026 Setting DEBUG logging. 2017-08-13 17:11:45,026 attempt 1/10 2017-08-13 17:11:45,026 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/e594b178728b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-13 17:11:45,642 sleeping for 10.00s (attempt 1/10) 2017-08-13 17:11:55,652 attempt 2/10 2017-08-13 17:11:55,653 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/e594b178728b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-13 17:11:56,439 unpacking tar archive at: mozilla-central-e594b178728b/testing/mozharness/ program finished with exit code 0 elapsedTime=11.725326 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 11 secs) (at 2017-08-13 17:11:55.752893) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:55.753235) ========= script_repo_revision: e594b178728bc6a51fc81bffcb1d6f0a7071cd33 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:55.753670) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:55.753992) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-13 17:11:55.762835) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-08-13 17:11:55.763158) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:11:56 INFO - MultiFileLogger online at 20170813 17:11:56 in /builds/slave/test 17:11:56 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 17:11:56 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:11:56 INFO - {'append_to_log': False, 17:11:56 INFO - 'base_work_dir': '/builds/slave/test', 17:11:56 INFO - 'blob_upload_branch': 'Firefox', 17:11:56 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:11:56 INFO - 'branch': 'Firefox', 17:11:56 INFO - 'buildbot_json_path': 'buildprops.json', 17:11:56 INFO - 'code_coverage': False, 17:11:56 INFO - 'config_files': ('talos/linux_config.py',), 17:11:56 INFO - 'default_actions': ('clobber', 17:11:56 INFO - 'read-buildbot-config', 17:11:56 INFO - 'download-and-extract', 17:11:56 INFO - 'populate-webroot', 17:11:56 INFO - 'create-virtualenv', 17:11:56 INFO - 'install', 17:11:56 INFO - 'setup-mitmproxy', 17:11:56 INFO - 'run-tests'), 17:11:56 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:11:56 INFO - 'disable_ccov_upload': False, 17:11:56 INFO - 'download_minidump_stackwalk': True, 17:11:56 INFO - 'download_symbols': 'ondemand', 17:11:56 INFO - 'enable_stylo': False, 17:11:56 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:11:56 INFO - 'tooltool.py': '/tools/tooltool.py', 17:11:56 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:11:56 INFO - '/tools/misc-python/virtualenv.py')}, 17:11:56 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:11:56 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:11:56 INFO - 'gecko_profile': False, 17:11:56 INFO - 'gecko_profile_interval': 0, 17:11:56 INFO - 'installer_path': 'installer.exe', 17:11:56 INFO - 'log_level': 'info', 17:11:56 INFO - 'log_name': 'talos', 17:11:56 INFO - 'log_to_console': True, 17:11:56 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:11:56 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:11:56 INFO - 'opt_config_files': (), 17:11:56 INFO - 'pip_index': False, 17:11:56 INFO - 'suite': 'dromaeojs-e10s', 17:11:56 INFO - 'system_bits': '32', 17:11:56 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:11:56 INFO - 'title': 'talos-linux64-ix-062', 17:11:56 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:11:56 INFO - 'use_talos_json': True, 17:11:56 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:11:56 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:11:56 INFO - 'work_dir': 'build'} 17:11:56 INFO - [mozharness: 2017-08-14 00:11:56.875547Z] Running clobber step. 17:11:56 INFO - Running pre-action listener: _resource_record_pre_action 17:11:56 INFO - Running main action method: clobber 17:11:56 INFO - rmtree: /builds/slave/test/build 17:11:56 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:11:57 INFO - Running post-action listener: _resource_record_post_action 17:11:57 INFO - [mozharness: 2017-08-14 00:11:57.912447Z] Finished clobber step (success) 17:11:57 INFO - [mozharness: 2017-08-14 00:11:57.912550Z] Running read-buildbot-config step. 17:11:57 INFO - Running pre-action listener: _resource_record_pre_action 17:11:57 INFO - Running main action method: read_buildbot_config 17:11:57 INFO - Using buildbot properties: 17:11:57 INFO - { 17:11:57 INFO - "project": "", 17:11:57 INFO - "product": "firefox", 17:11:57 INFO - "who": "archaeopteryx@coole-files.de", 17:11:57 INFO - "installer_path": "public/build/target.tar.bz2", 17:11:57 INFO - "builddir": "mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s", 17:11:57 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 17:11:57 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo-sequential mozilla-central talos dromaeojs-e10s", 17:11:57 INFO - "stage_platform": "linux64-stylosequential", 17:11:57 INFO - "basedir": "/builds/slave/test", 17:11:57 INFO - "buildnumber": 188, 17:11:57 INFO - "platform": "ubuntu64_hw_styloseq", 17:11:57 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 17:11:57 INFO - "slavebuilddir": "test", 17:11:57 INFO - "taskId": "Djp4nwf9Qtuo6FSwUdtDLQ", 17:11:57 INFO - "branch": "mozilla-central", 17:11:57 INFO - "script_repo_revision": "production", 17:11:57 INFO - "revision": "e594b178728bc6a51fc81bffcb1d6f0a7071cd33", 17:11:57 INFO - "slavename": "talos-linux64-ix-062", 17:11:57 INFO - "repo_path": "mozilla-central" 17:11:57 INFO - } 17:11:57 INFO - Finding installer, test and symbols from parent task. 17:11:57 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Djp4nwf9Qtuo6FSwUdtDLQ'}, attempt #1 17:11:58 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Djp4nwf9Qtuo6FSwUdtDLQ'}, attempt #1 17:11:58 INFO - Task dependencies: Cpe3HXCkQHyHzCn410T5Mw 17:11:58 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw'}, attempt #1 17:11:59 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2 17:11:59 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.test_packages.json 17:11:59 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.crashreporter-symbols.zip 17:11:59 INFO - Running post-action listener: _resource_record_post_action 17:11:59 INFO - [mozharness: 2017-08-14 00:11:59.343955Z] Finished read-buildbot-config step (success) 17:11:59 INFO - [mozharness: 2017-08-14 00:11:59.344177Z] Running download-and-extract step. 17:11:59 INFO - Running pre-action listener: _resource_record_pre_action 17:11:59 INFO - Running main action method: download_and_extract 17:11:59 INFO - mkdir: /builds/slave/test/build/tests 17:11:59 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')]} 17:11:59 INFO - trying https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.test_packages.json 17:11:59 INFO - Downloading https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 17:11:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 17:11:59 INFO - Downloaded 989 bytes. 17:11:59 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 17:11:59 INFO - Using the following test package requirements: 17:11:59 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 17:11:59 INFO - u'common': [u'target.common.tests.zip'], 17:11:59 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 17:11:59 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 17:11:59 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 17:11:59 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 17:11:59 INFO - u'mozbase': [u'target.common.tests.zip'], 17:11:59 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 17:11:59 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 17:11:59 INFO - u'web-platform': [u'target.common.tests.zip', 17:11:59 INFO - u'target.web-platform.tests.tar.gz'], 17:11:59 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 17:11:59 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 17:11:59 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.common.tests.zip 17:11:59 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.common.tests.zip'}, attempt #1 17:11:59 INFO - Fetch https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.common.tests.zip into memory 17:12:01 INFO - Content-Length response header: 54034790 17:12:01 INFO - Bytes received: 54034790 17:12:12 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 17:12:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.common.tests.zip 17:12:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.common.tests.zip'}, attempt #1 17:12:12 INFO - Fetch https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.common.tests.zip into memory 17:12:13 INFO - Content-Length response header: 54034790 17:12:13 INFO - Bytes received: 54034790 17:12:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.talos.tests.zip 17:12:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 17:12:25 INFO - Fetch https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.talos.tests.zip into memory 17:12:26 INFO - Content-Length response header: 14496050 17:12:26 INFO - Bytes received: 14496050 17:12: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')]} 17:12:27 INFO - trying https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2 17:12:27 INFO - Downloading https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 17:12:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 17:12:29 INFO - Downloaded 61731308 bytes. 17:12:29 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2 17:12:29 INFO - mkdir: /builds/slave/test/properties 17:12:29 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:12:29 INFO - Writing to file /builds/slave/test/properties/build_url 17:12:29 INFO - Contents: 17:12:29 INFO - build_url:https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2 17:12:29 INFO - Running post-action listener: _resource_record_post_action 17:12:29 INFO - Running post-action listener: set_extra_try_arguments 17:12:29 INFO - [mozharness: 2017-08-14 00:12:29.740356Z] Finished download-and-extract step (success) 17:12:29 INFO - [mozharness: 2017-08-14 00:12:29.740588Z] Running populate-webroot step. 17:12:29 INFO - Running pre-action listener: _resource_record_pre_action 17:12:29 INFO - Running main action method: populate_webroot 17:12:29 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 17:12:29 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 17:12:29 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 17:12:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:12:29 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 17:12:29 INFO - 'tests': ['damp', 'tps']}, 17:12:29 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:12:29 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 17:12:29 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 17:12:29 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 17:12:29 INFO - 'other-e10s': {'tests': ['a11yr', 17:12:29 INFO - 'ts_paint', 17:12:29 INFO - 'tpaint', 17:12:29 INFO - 'sessionrestore', 17:12:29 INFO - 'sessionrestore_many_windows', 17:12:29 INFO - 'sessionrestore_no_auto_restore', 17:12:29 INFO - 'tabpaint']}, 17:12:29 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 17:12:29 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 17:12:29 INFO - 'svgr-e10s': {'tests': ['tsvgx', 17:12:29 INFO - 'tsvgr_opacity', 17:12:29 INFO - 'tart', 17:12:29 INFO - 'tscrollx', 17:12:29 INFO - 'tsvg_static']}, 17:12:29 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 17:12:29 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 17:12:29 INFO - 'talos_options': ['--mitmproxy', 17:12:29 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 17:12:29 INFO - '--firstNonBlankPaint'], 17:12:29 INFO - 'tests': ['tp6_google', 17:12:29 INFO - 'tp6_youtube', 17:12:29 INFO - 'tp6_amazon', 17:12:29 INFO - 'tp6_facebook']}, 17:12:29 INFO - 'tp6-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 17:12:29 INFO - 'talos_options': ['--stylo', 17:12:29 INFO - '--mitmproxy', 17:12:29 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 17:12:29 INFO - '--firstNonBlankPaint'], 17:12:29 INFO - 'tests': ['tp6_google', 17:12:29 INFO - 'tp6_youtube', 17:12:29 INFO - 'tp6_amazon', 17:12:29 INFO - 'tp6_facebook']}, 17:12:29 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 17:12:29 INFO - 'talos_options': ['--stylo', 17:12:29 INFO - '--stylo-threads=1', 17:12:29 INFO - '--mitmproxy', 17:12:29 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 17:12:29 INFO - '--firstNonBlankPaint'], 17:12:29 INFO - 'tests': ['tp6_google', 17:12:29 INFO - 'tp6_youtube', 17:12:29 INFO - 'tp6_amazon', 17:12:29 INFO - 'tp6_facebook']}, 17:12:29 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 17:12:29 INFO - 'talos_options': ['--xperf_path', 17:12:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:12:29 INFO - 'tests': ['tp5n']}}} 17:12:29 INFO - Running post-action listener: _resource_record_post_action 17:12:29 INFO - [mozharness: 2017-08-14 00:12:29.756871Z] Finished populate-webroot step (success) 17:12:29 INFO - [mozharness: 2017-08-14 00:12:29.756962Z] Running create-virtualenv step. 17:12:29 INFO - Running pre-action listener: _resource_record_pre_action 17:12:29 INFO - Running main action method: create_virtualenv 17:12:29 INFO - Creating virtualenv /builds/slave/test/build/venv 17:12:29 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 17:12:29 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:12:29 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 17:12:29 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:12:29 INFO - Using real prefix '/usr' 17:12:29 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:12:30 INFO - Installing distribute.............................................................................................................................................................................................done. 17:12:32 INFO - Installing pip.................done. 17:12:32 INFO - Return code: 0 17:12:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 17:12:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 17:12:32 INFO - Reading from file tmpfile_stdout 17:12:32 INFO - Output received: 17:12:32 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 17:12:32 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:12:32 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')]} 17:12:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:32 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')]} 17:12:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:32 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 17:12:32 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 17:12:32 INFO - Using env: {'DISPLAY': ':0', 17:12:32 INFO - 'HOME': '/home/cltbld', 17:12:32 INFO - 'LANG': 'en_US.UTF-8', 17:12:32 INFO - 'LANGUAGE': 'en_US:en', 17:12:32 INFO - 'LOGNAME': 'cltbld', 17:12:32 INFO - 'MAIL': '/var/mail/cltbld', 17:12:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:32 INFO - 'MOZ_NO_REMOTE': '1', 17:12:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:32 INFO - 'NO_EM_RESTART': '1', 17:12:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:32 INFO - 'PWD': '/builds/slave/test', 17:12:32 INFO - 'SHELL': '/bin/bash', 17:12:32 INFO - 'SHLVL': '1', 17:12:32 INFO - 'TERM': 'linux', 17:12:32 INFO - 'TMOUT': '86400', 17:12:32 INFO - 'USER': 'cltbld', 17:12:32 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:32 INFO - '_': '/tools/buildbot/bin/python'} 17:12:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:32 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 17:12:32 INFO - Cleaning up... 17:12:32 INFO - Return code: 0 17:12:32 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 17:12:32 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')]} 17:12:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:32 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')]} 17:12:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:32 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 17:12:32 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 17:12:32 INFO - Using env: {'DISPLAY': ':0', 17:12:32 INFO - 'HOME': '/home/cltbld', 17:12:32 INFO - 'LANG': 'en_US.UTF-8', 17:12:32 INFO - 'LANGUAGE': 'en_US:en', 17:12:32 INFO - 'LOGNAME': 'cltbld', 17:12:32 INFO - 'MAIL': '/var/mail/cltbld', 17:12:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:32 INFO - 'MOZ_NO_REMOTE': '1', 17:12:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:32 INFO - 'NO_EM_RESTART': '1', 17:12:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:32 INFO - 'PWD': '/builds/slave/test', 17:12:32 INFO - 'SHELL': '/bin/bash', 17:12:32 INFO - 'SHLVL': '1', 17:12:32 INFO - 'TERM': 'linux', 17:12:32 INFO - 'TMOUT': '86400', 17:12:32 INFO - 'USER': 'cltbld', 17:12:32 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:32 INFO - '_': '/tools/buildbot/bin/python'} 17:12:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:32 INFO - Downloading/unpacking psutil>=3.1.1 17:12:32 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 17:12:32 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 17:12:32 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 17:12:32 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 17:12:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:12:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:12:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:12:34 INFO - Installing collected packages: psutil 17:12:34 INFO - Running setup.py install for psutil 17:12:34 INFO - building 'psutil._psutil_linux' extension 17:12:34 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 17:12:34 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 17:12:34 INFO - building 'psutil._psutil_posix' extension 17:12:34 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 17:12:34 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 17:12:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:12:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:12:34 INFO - Successfully installed psutil 17:12:34 INFO - Cleaning up... 17:12:34 INFO - Return code: 0 17:12:34 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 17:12:34 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')]} 17:12:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:34 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')]} 17:12:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:34 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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:34 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 17:12:34 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 17:12:34 INFO - Using env: {'DISPLAY': ':0', 17:12:34 INFO - 'HOME': '/home/cltbld', 17:12:34 INFO - 'LANG': 'en_US.UTF-8', 17:12:34 INFO - 'LANGUAGE': 'en_US:en', 17:12:34 INFO - 'LOGNAME': 'cltbld', 17:12:34 INFO - 'MAIL': '/var/mail/cltbld', 17:12:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:34 INFO - 'MOZ_NO_REMOTE': '1', 17:12:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:34 INFO - 'NO_EM_RESTART': '1', 17:12:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:34 INFO - 'PWD': '/builds/slave/test', 17:12:34 INFO - 'SHELL': '/bin/bash', 17:12:34 INFO - 'SHLVL': '1', 17:12:34 INFO - 'TERM': 'linux', 17:12:34 INFO - 'TMOUT': '86400', 17:12:34 INFO - 'USER': 'cltbld', 17:12:34 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:34 INFO - '_': '/tools/buildbot/bin/python'} 17:12:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:34 INFO - Downloading/unpacking mozsystemmonitor==0.3 17:12: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 17:12: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 17:12: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 17:12: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 17:12:36 INFO - Downloading mozsystemmonitor-0.3.tar.gz 17:12:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:12:36 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 17:12:36 INFO - Installing collected packages: mozsystemmonitor 17:12:36 INFO - Running setup.py install for mozsystemmonitor 17:12:36 INFO - Successfully installed mozsystemmonitor 17:12:36 INFO - Cleaning up... 17:12:36 INFO - Return code: 0 17:12:36 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 17:12: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')]} 17:12:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12: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')]} 17:12:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12: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', '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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 17:12: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 jsonschema==2.5.1 17:12:36 INFO - Using env: {'DISPLAY': ':0', 17:12:36 INFO - 'HOME': '/home/cltbld', 17:12:36 INFO - 'LANG': 'en_US.UTF-8', 17:12:36 INFO - 'LANGUAGE': 'en_US:en', 17:12:36 INFO - 'LOGNAME': 'cltbld', 17:12:36 INFO - 'MAIL': '/var/mail/cltbld', 17:12:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:36 INFO - 'MOZ_NO_REMOTE': '1', 17:12:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:36 INFO - 'NO_EM_RESTART': '1', 17:12:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:36 INFO - 'PWD': '/builds/slave/test', 17:12:36 INFO - 'SHELL': '/bin/bash', 17:12:36 INFO - 'SHLVL': '1', 17:12:36 INFO - 'TERM': 'linux', 17:12:36 INFO - 'TMOUT': '86400', 17:12:36 INFO - 'USER': 'cltbld', 17:12:36 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:36 INFO - '_': '/tools/buildbot/bin/python'} 17:12:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:36 INFO - Downloading/unpacking jsonschema==2.5.1 17:12: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 17:12: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 17:12: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 17:12: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 17:12:37 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:12:37 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 17:12: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 17:12: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 17:12: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 17:12: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 17:12:37 INFO - Downloading functools32-3.2.3-2.tar.gz 17:12:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:12:37 INFO - warning: no files found matching '*.txt' 17:12:37 INFO - no previously-included directories found matching 'build' 17:12:37 INFO - no previously-included directories found matching 'dist' 17:12:37 INFO - no previously-included directories found matching '.git*' 17:12:37 INFO - Installing collected packages: jsonschema, functools32 17:12:37 INFO - Running setup.py install for functools32 17:12:37 INFO - warning: no files found matching '*.txt' 17:12:37 INFO - no previously-included directories found matching 'build' 17:12:37 INFO - no previously-included directories found matching 'dist' 17:12:37 INFO - no previously-included directories found matching '.git*' 17:12:37 INFO - Successfully installed jsonschema functools32 17:12:37 INFO - Cleaning up... 17:12:37 INFO - Return code: 0 17:12:37 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 17:12:37 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')]} 17:12:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:37 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')]} 17:12:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:37 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 17:12:37 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 17:12:37 INFO - Using env: {'DISPLAY': ':0', 17:12:37 INFO - 'HOME': '/home/cltbld', 17:12:37 INFO - 'LANG': 'en_US.UTF-8', 17:12:37 INFO - 'LANGUAGE': 'en_US:en', 17:12:37 INFO - 'LOGNAME': 'cltbld', 17:12:37 INFO - 'MAIL': '/var/mail/cltbld', 17:12:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:37 INFO - 'MOZ_NO_REMOTE': '1', 17:12:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:37 INFO - 'NO_EM_RESTART': '1', 17:12:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:37 INFO - 'PWD': '/builds/slave/test', 17:12:37 INFO - 'SHELL': '/bin/bash', 17:12:37 INFO - 'SHLVL': '1', 17:12:37 INFO - 'TERM': 'linux', 17:12:37 INFO - 'TMOUT': '86400', 17:12:37 INFO - 'USER': 'cltbld', 17:12:37 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:37 INFO - '_': '/tools/buildbot/bin/python'} 17:12:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:38 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 17:12:38 INFO - Cleaning up... 17:12:38 INFO - Return code: 0 17:12:38 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:12: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')]} 17:12:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12: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')]} 17:12:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:38 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 17:12:38 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 17:12:38 INFO - Using env: {'DISPLAY': ':0', 17:12:38 INFO - 'HOME': '/home/cltbld', 17:12:38 INFO - 'LANG': 'en_US.UTF-8', 17:12:38 INFO - 'LANGUAGE': 'en_US:en', 17:12:38 INFO - 'LOGNAME': 'cltbld', 17:12:38 INFO - 'MAIL': '/var/mail/cltbld', 17:12:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:38 INFO - 'MOZ_NO_REMOTE': '1', 17:12:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:38 INFO - 'NO_EM_RESTART': '1', 17:12:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:38 INFO - 'PWD': '/builds/slave/test', 17:12:38 INFO - 'SHELL': '/bin/bash', 17:12:38 INFO - 'SHLVL': '1', 17:12:38 INFO - 'TERM': 'linux', 17:12:38 INFO - 'TMOUT': '86400', 17:12:38 INFO - 'USER': 'cltbld', 17:12:38 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:38 INFO - '_': '/tools/buildbot/bin/python'} 17:12:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:38 INFO - Downloading/unpacking blobuploader==1.2.4 17:12: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 17:12: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 17:12: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 17:12: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 17:12:39 INFO - Downloading blobuploader-1.2.4.tar.gz 17:12:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:12:39 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:12:39 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 17:12:39 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 17:12:39 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 17:12:39 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 17:12:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:12:39 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:12:39 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 17:12:39 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 17:12:39 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 17:12:39 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 17:12:39 INFO - Downloading docopt-0.6.1.tar.gz 17:12:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:12:40 INFO - Installing collected packages: blobuploader, requests, docopt 17:12:40 INFO - Running setup.py install for blobuploader 17:12:40 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:12:40 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:12:40 INFO - Running setup.py install for requests 17:12:40 INFO - Running setup.py install for docopt 17:12:40 INFO - Successfully installed blobuploader requests docopt 17:12:40 INFO - Cleaning up... 17:12:40 INFO - Return code: 0 17:12:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:12:40 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')]} 17:12:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:40 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')]} 17:12:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:40 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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:40 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 17:12:40 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 17:12:40 INFO - Using env: {'DISPLAY': ':0', 17:12:40 INFO - 'HOME': '/home/cltbld', 17:12:40 INFO - 'LANG': 'en_US.UTF-8', 17:12:40 INFO - 'LANGUAGE': 'en_US:en', 17:12:40 INFO - 'LOGNAME': 'cltbld', 17:12:40 INFO - 'MAIL': '/var/mail/cltbld', 17:12:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:40 INFO - 'MOZ_NO_REMOTE': '1', 17:12:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:40 INFO - 'NO_EM_RESTART': '1', 17:12:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:40 INFO - 'PWD': '/builds/slave/test', 17:12:40 INFO - 'SHELL': '/bin/bash', 17:12:40 INFO - 'SHLVL': '1', 17:12:40 INFO - 'TERM': 'linux', 17:12:40 INFO - 'TMOUT': '86400', 17:12:40 INFO - 'USER': 'cltbld', 17:12:40 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:40 INFO - '_': '/tools/buildbot/bin/python'} 17:12:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:12:40 INFO - Running setup.py (path:/tmp/pip-8WoAs6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:12:40 INFO - Running setup.py (path:/tmp/pip-VmSp_H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:12:41 INFO - Running setup.py (path:/tmp/pip-K3JF9q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:12:41 INFO - Running setup.py (path:/tmp/pip-syyXXF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:12:41 INFO - Running setup.py (path:/tmp/pip-hZ9Cnu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:12:41 INFO - Running setup.py (path:/tmp/pip-SIerO5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:12:41 INFO - Running setup.py (path:/tmp/pip-8qYpA9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:12:41 INFO - Running setup.py (path:/tmp/pip-atUYZB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:12:41 INFO - Running setup.py (path:/tmp/pip-dpDJM9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:12:41 INFO - Running setup.py (path:/tmp/pip-AAg5YD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:12:41 INFO - Running setup.py (path:/tmp/pip-TxWfta-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:12:41 INFO - Running setup.py (path:/tmp/pip-sfwBYr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:12:41 INFO - Running setup.py (path:/tmp/pip-TN1r7o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:12:41 INFO - Running setup.py (path:/tmp/pip-9kvMaE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:12:41 INFO - Running setup.py (path:/tmp/pip-nfRClj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:12:41 INFO - Running setup.py (path:/tmp/pip-6o1V7I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:12:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:12:42 INFO - Running setup.py (path:/tmp/pip-RnVybu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:12:42 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:12:42 INFO - Running setup.py install for manifestparser 17:12:42 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Running setup.py install for mozcrash 17:12:42 INFO - Running setup.py install for mozdebug 17:12:42 INFO - Running setup.py install for mozdevice 17:12:42 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Running setup.py install for mozfile 17:12:42 INFO - Running setup.py install for mozhttpd 17:12:42 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Running setup.py install for mozinfo 17:12:42 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Running setup.py install for mozInstall 17:12:42 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:12:42 INFO - Running setup.py install for mozleak 17:12:43 INFO - Running setup.py install for mozlog 17:12:43 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:12:43 INFO - Running setup.py install for moznetwork 17:12:43 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:12:43 INFO - Running setup.py install for mozprocess 17:12:43 INFO - Running setup.py install for mozprofile 17:12:43 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:12:43 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:12:43 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:12:43 INFO - Running setup.py install for mozrunner 17:12:43 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:12:43 INFO - Running setup.py install for mozscreenshot 17:12:43 INFO - Running setup.py install for moztest 17:12:43 INFO - Running setup.py install for mozversion 17:12:43 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:12:43 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:12:43 INFO - Cleaning up... 17:12:43 INFO - Return code: 0 17:12:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:12:43 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')]} 17:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:43 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')]} 17:12:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:43 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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:43 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 17:12:43 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 17:12:43 INFO - Using env: {'DISPLAY': ':0', 17:12:43 INFO - 'HOME': '/home/cltbld', 17:12:43 INFO - 'LANG': 'en_US.UTF-8', 17:12:43 INFO - 'LANGUAGE': 'en_US:en', 17:12:43 INFO - 'LOGNAME': 'cltbld', 17:12:43 INFO - 'MAIL': '/var/mail/cltbld', 17:12:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:43 INFO - 'MOZ_NO_REMOTE': '1', 17:12:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:43 INFO - 'NO_EM_RESTART': '1', 17:12:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:43 INFO - 'PWD': '/builds/slave/test', 17:12:43 INFO - 'SHELL': '/bin/bash', 17:12:43 INFO - 'SHLVL': '1', 17:12:43 INFO - 'TERM': 'linux', 17:12:43 INFO - 'TMOUT': '86400', 17:12:43 INFO - 'USER': 'cltbld', 17:12:43 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:43 INFO - '_': '/tools/buildbot/bin/python'} 17:12:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:12:44 INFO - Running setup.py (path:/tmp/pip-NDVdXN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:12:44 INFO - Running setup.py (path:/tmp/pip-4nnTCa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:12:44 INFO - Running setup.py (path:/tmp/pip-a_7j8d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:12:44 INFO - Running setup.py (path:/tmp/pip-qZRvgu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:12:44 INFO - Running setup.py (path:/tmp/pip-oFsShV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:12:44 INFO - Running setup.py (path:/tmp/pip-4OnALA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:12:44 INFO - Running setup.py (path:/tmp/pip-e2_2XV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:12:44 INFO - Running setup.py (path:/tmp/pip-2g7p3_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:12:44 INFO - Running setup.py (path:/tmp/pip-DZFT2u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:12:44 INFO - Running setup.py (path:/tmp/pip-SThZUo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:12:44 INFO - Running setup.py (path:/tmp/pip-33eoX1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:12:44 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)) 17:12:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:12:44 INFO - Running setup.py (path:/tmp/pip-7uQB3j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:12:45 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)) 17:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:12:45 INFO - Running setup.py (path:/tmp/pip-9isU9V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:12:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 17:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:12:45 INFO - Running setup.py (path:/tmp/pip-1ASaXr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:12:45 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)) 17:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:12:45 INFO - Running setup.py (path:/tmp/pip-bcgwoD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:12:45 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)) 17:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:12:45 INFO - Running setup.py (path:/tmp/pip-5qZJS_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:12:45 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)) 17:12:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:12:45 INFO - Running setup.py (path:/tmp/pip-ONF31Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:12:45 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)) 17:12:45 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)) 17:12:45 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)) 17:12:45 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)) 17:12:45 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)) 17:12:45 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)) 17:12:45 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)) 17:12:45 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:12: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 17:12: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 17:12: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 17:12: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 17:12:46 INFO - Downloading blessings-1.6.tar.gz 17:12:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:12:46 INFO - Installing collected packages: blessings 17:12:46 INFO - Running setup.py install for blessings 17:12:46 INFO - Successfully installed blessings 17:12:46 INFO - Cleaning up... 17:12:46 INFO - Return code: 0 17:12:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:12:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:12:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:12:46 INFO - Reading from file tmpfile_stdout 17:12:46 INFO - Current package versions: 17:12:46 INFO - argparse == 1.2.1 17:12:46 INFO - blessings == 1.6 17:12:46 INFO - blobuploader == 1.2.4 17:12:46 INFO - docopt == 0.6.1 17:12:46 INFO - functools32 == 3.2.3-2 17:12:46 INFO - jsonschema == 2.5.1 17:12:46 INFO - manifestparser == 1.1 17:12:46 INFO - mozInstall == 1.13 17:12:46 INFO - mozcrash == 1.0 17:12:46 INFO - mozdebug == 0.1 17:12:46 INFO - mozdevice == 0.51 17:12:46 INFO - mozfile == 1.2 17:12:46 INFO - mozhttpd == 0.7 17:12:46 INFO - mozinfo == 0.10 17:12:46 INFO - mozleak == 0.1 17:12:46 INFO - mozlog == 3.5 17:12:46 INFO - moznetwork == 0.27 17:12:46 INFO - mozprocess == 0.25 17:12:46 INFO - mozprofile == 0.28 17:12:46 INFO - mozrunner == 6.13 17:12:46 INFO - mozscreenshot == 0.1 17:12:46 INFO - mozsystemmonitor == 0.3 17:12:46 INFO - moztest == 0.8 17:12:46 INFO - mozversion == 1.4 17:12:46 INFO - psutil == 3.1.1 17:12:46 INFO - requests == 1.2.3 17:12:46 INFO - wsgiref == 0.1.2 17:12:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:12:46 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')]} 17:12:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:46 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')]} 17:12:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:46 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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:46 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 17:12:46 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 17:12:46 INFO - Using env: {'DISPLAY': ':0', 17:12:46 INFO - 'HOME': '/home/cltbld', 17:12:46 INFO - 'LANG': 'en_US.UTF-8', 17:12:46 INFO - 'LANGUAGE': 'en_US:en', 17:12:46 INFO - 'LOGNAME': 'cltbld', 17:12:46 INFO - 'MAIL': '/var/mail/cltbld', 17:12:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:46 INFO - 'MOZ_NO_REMOTE': '1', 17:12:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:46 INFO - 'NO_EM_RESTART': '1', 17:12:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:46 INFO - 'PWD': '/builds/slave/test', 17:12:46 INFO - 'SHELL': '/bin/bash', 17:12:46 INFO - 'SHLVL': '1', 17:12:46 INFO - 'TERM': 'linux', 17:12:46 INFO - 'TMOUT': '86400', 17:12:46 INFO - 'USER': 'cltbld', 17:12:46 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:46 INFO - '_': '/tools/buildbot/bin/python'} 17:12:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:47 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)) 17:12:47 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)) 17:12:47 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)) 17:12:47 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)) 17:12:47 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)) 17:12:47 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)) 17:12:47 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)) 17:12:47 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)) 17:12:47 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)) 17:12:47 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 17:12:47 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 17:12:47 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 17:12:47 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 17:12:47 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 17:12:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 17:12:48 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:12:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:12:48 INFO - Installing collected packages: simplejson 17:12:48 INFO - Running setup.py install for simplejson 17:12:48 INFO - building 'simplejson._speedups' extension 17:12:48 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 17:12:49 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 17:12:49 INFO - Successfully installed simplejson 17:12:49 INFO - Cleaning up... 17:12:49 INFO - Return code: 0 17:12:49 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:12:49 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')]} 17:12:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:12:49 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')]} 17:12:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:12:49 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 0xc7d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe49a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfeab20>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', '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 17:12:49 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 17:12:49 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 17:12:49 INFO - Using env: {'DISPLAY': ':0', 17:12:49 INFO - 'HOME': '/home/cltbld', 17:12:49 INFO - 'LANG': 'en_US.UTF-8', 17:12:49 INFO - 'LANGUAGE': 'en_US:en', 17:12:49 INFO - 'LOGNAME': 'cltbld', 17:12:49 INFO - 'MAIL': '/var/mail/cltbld', 17:12:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:12:49 INFO - 'MOZ_NO_REMOTE': '1', 17:12:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:12:49 INFO - 'NO_EM_RESTART': '1', 17:12:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:12:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:12:49 INFO - 'PWD': '/builds/slave/test', 17:12:49 INFO - 'SHELL': '/bin/bash', 17:12:49 INFO - 'SHLVL': '1', 17:12:49 INFO - 'TERM': 'linux', 17:12:49 INFO - 'TMOUT': '86400', 17:12:49 INFO - 'USER': 'cltbld', 17:12:49 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:12:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:12:49 INFO - '_': '/tools/buildbot/bin/python'} 17:12:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:12:49 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 17:12:49 INFO - Cleaning up... 17:12:49 INFO - Return code: 0 17:12:49 INFO - Running post-action listener: _resource_record_post_action 17:12:49 INFO - Running post-action listener: _start_resource_monitoring 17:12:49 INFO - Starting resource monitoring. 17:12:49 INFO - [mozharness: 2017-08-14 00:12:49.652994Z] Finished create-virtualenv step (success) 17:12:49 INFO - [mozharness: 2017-08-14 00:12:49.653551Z] Running install step. 17:12:49 INFO - Running pre-action listener: _resource_record_pre_action 17:12:49 INFO - Running main action method: install 17:12:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:12:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:12:49 INFO - Reading from file tmpfile_stdout 17:12:49 INFO - Detecting whether we're running mozinstall >=1.0... 17:12:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:12:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:12:50 INFO - Reading from file tmpfile_stdout 17:12:50 INFO - Output received: 17:12:50 INFO - Usage: mozinstall [options] installer 17:12:50 INFO - Options: 17:12:50 INFO - -h, --help show this help message and exit 17:12:50 INFO - -d DEST, --destination=DEST 17:12:50 INFO - Directory to install application into. [default: 17:12:50 INFO - "/builds/slave/test"] 17:12:50 INFO - --app=APP Application being installed. [default: firefox] 17:12:50 INFO - mkdir: /builds/slave/test/build/application 17:12:50 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'] 17:12:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 17:13:07 INFO - Reading from file tmpfile_stdout 17:13:07 INFO - Output received: 17:13:07 INFO - /builds/slave/test/build/application/firefox/firefox 17:13:07 INFO - Running post-action listener: _resource_record_post_action 17:13:07 INFO - [mozharness: 2017-08-14 00:13:07.906820Z] Finished install step (success) 17:13:07 INFO - [mozharness: 2017-08-14 00:13:07.907071Z] Running setup-mitmproxy step. 17:13:07 INFO - Running pre-action listener: _resource_record_pre_action 17:13:07 INFO - Running main action method: setup_mitmproxy 17:13:07 INFO - Skipping: mitmproxy is not required 17:13:07 INFO - Running post-action listener: _resource_record_post_action 17:13:07 INFO - [mozharness: 2017-08-14 00:13:07.908183Z] Finished setup-mitmproxy step (success) 17:13:07 INFO - [mozharness: 2017-08-14 00:13:07.908416Z] Running run-tests step. 17:13:07 INFO - Running pre-action listener: _resource_record_pre_action 17:13:07 INFO - Running pre-action listener: _set_gcov_prefix 17:13:07 INFO - Running main action method: run_tests 17:13:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:13:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:13:07 INFO - Python 2.7.3 17:13:07 INFO - Return code: 0 17:13:07 INFO - grabbing minidump binary from tooltool 17:13:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:13:07 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfedf00>, '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 0xfe8ba0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe9050>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:13:07 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 17:13:07 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 17:13:07 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 17:13:07 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:13:08 INFO - Return code: 0 17:13:08 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 17:13:08 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:13:08 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:13:08 INFO - ENV: RUST_BACKTRACE is now full 17:13:08 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 17:13:08 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:13:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 17:13:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-062 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 17:13:08 INFO - Using env: {'DISPLAY': ':0', 17:13:08 INFO - 'HOME': '/home/cltbld', 17:13:08 INFO - 'LANG': 'en_US.UTF-8', 17:13:08 INFO - 'LANGUAGE': 'en_US:en', 17:13:08 INFO - 'LOGNAME': 'cltbld', 17:13:08 INFO - 'MAIL': '/var/mail/cltbld', 17:13:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:13:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 17:13:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:13:08 INFO - 'MOZ_NO_REMOTE': '1', 17:13:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:13:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:13:08 INFO - 'NO_EM_RESTART': '1', 17:13:08 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:13:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:13:08 INFO - 'PWD': '/builds/slave/test', 17:13:08 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:13:08 INFO - 'RUST_BACKTRACE': 'full', 17:13:08 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 17:13:08 INFO - 'SHELL': '/bin/bash', 17:13:08 INFO - 'SHLVL': '1', 17:13:08 INFO - 'STYLO_FORCE_ENABLED': '1', 17:13:08 INFO - 'TERM': 'linux', 17:13:08 INFO - 'TMOUT': '86400', 17:13:08 INFO - 'USER': 'cltbld', 17:13:08 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032', 17:13:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:13:08 INFO - '_': '/tools/buildbot/bin/python'} 17:13:08 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 17:13:08 INFO - mozversion application_buildid: 20170813232840 17:13:08 INFO - mozversion application_changeset: e594b178728bc6a51fc81bffcb1d6f0a7071cd33 17:13:08 INFO - mozversion application_display_name: Nightly 17:13:08 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:13:08 INFO - mozversion application_name: Firefox 17:13:08 INFO - mozversion application_remotingname: firefox 17:13:08 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 17:13:08 INFO - mozversion application_vendor: Mozilla 17:13:08 INFO - mozversion application_version: 57.0a1 17:13:08 INFO - mozversion platform_buildid: 20170813232840 17:13:08 INFO - mozversion platform_changeset: e594b178728bc6a51fc81bffcb1d6f0a7071cd33 17:13:08 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 17:13:08 INFO - mozversion platform_version: 57.0a1 17:13:08 INFO - using testdate: 1502669588 17:13:08 INFO - actual date: 1502669588 17:13:08 INFO - starting webserver on 'localhost:52184' 17:13:08 INFO - SUITE-START | Running 2 tests 17:13:08 INFO - TEST-START | dromaeo_css 17:13:08 INFO - Initialising browser for dromaeo_css test... 17:13:08 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52184/getInfo.html -profile /tmp/tmp_9jeZS/profile 17:13:08 INFO - TEST-INFO | started process 11114 (/builds/slave/test/build/application/firefox/firefox http://localhost:52184/getInfo.html) 17:13:13 INFO - TEST-INFO | 11114: exit 0 17:13:13 INFO - Browser initialized. 17:13:13 INFO - Running cycle 1/1 for dromaeo_css test... 17:13:13 INFO - TEST-INFO | started process 11344 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp_9jeZS/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 17:13:14 INFO - PID 11344 | 17:13:14 INFO - PID 11344 | (/builds/slave/test/build/application/firefox/firefox:11398): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 17:13:14 INFO - PID 11344 | 17:13:25 INFO - PID 11344 | RSS: Main: 168087552 17:13:25 INFO - PID 11344 | 17:16:23 INFO - PID 11344 | Cycle 1(1): loaded http://localhost:52184/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52184/tests/dromaeo/cssquery-ext.html) 17:16:25 INFO - PID 11344 | RSS: Main: 175493120 17:16:25 INFO - PID 11344 | 17:19:27 INFO - PID 11344 | Cycle 1(1): loaded http://localhost:52184/tests/dromaeo/cssquery-ext.html (next: http://localhost:52184/tests/dromaeo/cssquery-jquery.html) 17:19:28 INFO - PID 11344 | RSS: Main: 172523520 17:19:28 INFO - PID 11344 | 17:22:29 INFO - PID 11344 | Cycle 1(1): loaded http://localhost:52184/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52184/tests/dromaeo/cssquery-mootools.html) 17:22:30 INFO - PID 11344 | RSS: Main: 174690304 17:22:30 INFO - PID 11344 | 17:25:32 INFO - PID 11344 | Cycle 1(1): loaded http://localhost:52184/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52184/tests/dromaeo/cssquery-prototype.html) 17:25:32 INFO - PID 11344 | RSS: Main: 173010944 17:25:32 INFO - PID 11344 | 17:28:36 INFO - PID 11344 | Cycle 1(1): loaded http://localhost:52184/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52184/tests/dromaeo/cssquery-yui.html) 17:28:37 INFO - PID 11344 | RSS: Main: 176631808 17:28:37 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | Cycle 1(1): loaded http://localhost:52184/tests/dromaeo/cssquery-yui.html (next: http://localhost:52184/tests/dromaeo/cssquery-dojo.html) 17:31:39 INFO - PID 11344 | RSS: Main: 177348608 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | __start_tp_report 17:31:39 INFO - PID 11344 | _x_x_mozilla_page_load 17:31:39 INFO - PID 11344 | _x_x_mozilla_page_load_details 17:31:39 INFO - PID 11344 | |i|pagename|runs| 17:31:39 INFO - PID 11344 | |0;dojo.html;3115.4547954108025;3136.7647426443023;3158.9210269743253;3161.130689060508;3197.9200519987;6036.3661815509395;6088.634681919088;6092.725827337769;6143.8156855294355;6144;6021.397860213988;6041.365656606059;6102.450779429851;6112.358202388752;6121.785737499188;5600.075987462084;5602.38373778885;5627.437256274381;5664.150377443375;5677.545796336304;5623.971880140593;5629.099344104944;5647.8588035299035;5650.06773882311;5689.715514224293;5621.831345059634;5708.600397972144;5765.250517432728;5772.422757724236;5773.826785196451;5693.032184528619;5723.112917497794;5756.913646295288;5774.740136693859;5800.4489573490455;5529.861753456155;5540.196671482653;5631.915521267143;5674.574406919456;5694.316681998187;6085.726142323606;6109.327973922865;6110.052941794029;6122.234720659918;6147.815565533041;6643.966780166116;6741.528093033489;6764.661766911635;6772.8306792330095;6779.254282028973;6698.83252918676;6749.291324410915;6780.118584584022;6815.352541508599;6840.144981877265;6061.605995610271;6140.846478838065;6168.599041062316;6219.533534984849;6251.093591429218;6817.5568588041615;6820.795376138723;6825.761098361533;6840.418564421981;6870.175578930461;6464.353564643498;6487.643179625166;6567.34326567349;6573.375529324707;6573.934260657428;6492.415682588589;6553.2136143663065;6560.40956313934;6576.342365763386;6713.362230588184;6554.344565543408;6585.967070164715;6588.209414870246;6599.868002639921;6605.504587155982;6650.800475985729;6679.931211006216;6719.092922455406;6745.460363171032;6755;5326.627136100436;5340.546053585411;5352.759125839269;5436.700981446058;5450.100733379028;4559.954400456019;4601.608863246594;4603.976980115078;4608.124456353282;4619.145458090264;5778.133280008033;5832.270966129234;5833.912491312633;5848.5321174305955;5853.385394533598;6697.8995315070315;6743.393094621508;6773.762918297836;6806.047153398528;6808.5914845109455;5628.662280263197;5759.625624334405;5774.88450230993;5822.883542329129;5835.183074369592;5864.472197502245;5909.172715819789;5953.493953013955;5964.105384192406;5978.432048955342;6480.870382592322;6482.157319548429;6547.1161393211305;6551.541392102602;6558.245801732766;6688.531802773759;6691.0967019451755;6700.497462690415;6782.355676210752;6785.117934668461;6308.27454842699;6387.936120638734;6423.357664233539;6423.743050277936;6435.420812126931;6426.260979987362;6442.226932768098;6470.158879345843;6473.352664733489;6528.183977002875;6538.8365290868105;6561.475081993333;6647.734090636513;6663.600183988976;6720.361565651256;6499.935000649933;6502.349765023459;6523.3150519194805;6564.409203171737;6585.078089067439;6415;6436.517261205335;6478.4169424752;6517.4134327910715;6534;6309.873802524015;6311.0217916223055;6328.873422531431;6347.841303967438;6435.871282574416;6468.15913931186;6471.935280647133;6478.870422591616;6480.319566445455;6537.117489139096;6245.531585131042;6340.71466784005;6386.616802991835;6421.743130274736;6429.22849258092 17:31:39 INFO - PID 11344 | |1;ext.html;733.9669714862831;776.332354175409;799.1648727080201;805.3879051920542;1131.6718151735997;30234.697653023464;30883.69116308839;40453.190936181294;41302;41789.79105104478;41555.58444415555;41835.372469412905;41840.37239441411;42056.36915446271;42122;7447.18081011087;7591.8861217081785;7595.316421522062;7597.582132982684;7601.80995475112;7465.776026719207;7480.476366654337;7553.282438168365;7558.2063883292285;7580.393568514505;7097.751578694747;7504.5872477013745;7530.510516816389;7600.923990760105;7665.310122089011;7570.3565196958325;7634.770956871303;7640.961795191016;7641.235876412315;7643.044619422572;7352.816179595499;7380.0405947227055;7504.549727016397;7520.887186692204;7561.659725312375;37710.62289377098;38106;38132;38338.61661383379;38435.231295374215;3420.8973730788116;3425.5889293284717;3429.108431807723;3459.8616055357757;3467.5665541807275;30889.845550772327;30978.380432391452;31239.687603124134;31267.68732312693;31463.685363146305;4980.551750342451;5024.748762561857;5066.088104141253;5076.923846142311;5081.618878584121;174423;179630;179739.10130449396;179783;181724;47017;47221.29168062482;47303.763481182374;47395.76302118467;47476;49166.262506062434;49306.260406093934;49394;49632.255516167286;49682.50317496851;15116.319765610573;15136.091834489966;15273.694526109637;15323.157226352658;15356.692866142615;12572.308523031139;12581.811272830915;12593.244405335709;12594.307313097685;12605.432755526022;14180.078294910798;14196.148231106166;14198;14307.64230894236;14360.497382591559;4871.131209155191;5764.74058667361;5829.271341082364;5915.225432370272;5917.5857689961285;981.1562056631292;998.3460833154296;1003.1673710820002;1008.2035192198082;1017.308230403318;22547.0981160755;28187.43625127527;28987.56518652222;29256.561151582744;29539.704602954123;1039.2413538117066;1073.7315671082229;1076.2735153771173;1087.130295763402;1090.9454527273604;12147.210431321935;12218.816717749241;12289.938550307192;12294.139410241198;12304.938475307745;236609;236989;238090;238575;242258;51235;51251.23123153156;51351.229731554056;51399;51900;1413.2297897645808;1473.1308527968336;1477.224457159978;1478.9260536973109;1479.6300924768807;21719.457013574785;22357.44106397288;22385;22743.431414214778;22781.202657906895;36493;36520.45219321659;36699.26601467902;36888.63111368852;37024.81487592545;200838;201148;201897;204247;204384;33244.833775830964;33893.3221335567;33996.830015849766;34179.48730768991;34283.14292142716;35889.46165807567;36182;42827.57172428236;43034.41793492401;43295.78352108345;28740;31159.84420077885;31264.531032034993;31376.372472550876;31745.20636984094;30578.235544111576;31179.84410077935;31199.84400077985;31297.374052519277;31644;34135;37581.43627845639;38494.80752596219;38643.420348695356;38677.41983870188;33181.50227746634;33206.335873282886;33274.500882487264;33738.83130584331;34330.65669343275;22317.218897338516;24370.512589747752;24560.877195613906;24699.62950555779;24817.379565511008 17:31:39 INFO - PID 11344 | |2;jquery.html;547.5373309553429;554.2683657572006;559.3092530724557;562.4319437368257;571.894199573079;21565.353039408823;22323.218687345947;22431.102755889766;22677.09291628337;22715.886420567873;24675;25459;26282.6057609136;26288.605670914905;26650.600240996402;6389.520785941061;6585.012248162766;6593.604383736967;6604.603723776589;6651.767188148416;6269.529785266123;6459.35406459355;6503.707333169995;6539.215294164707;6563.868722625544;6476.190476190476;6516.804495865108;6517.250516190627;6517.67411629419;6524.086627872078;6458.709358078898;6473.44975677068;6473.579217350857;6519.739210431577;6527.738890444401;5998.130271110665;5999.250093738283;6020.608660437058;6022.638641681513;6028;28504.857475712695;29611.407771844442;30219.848900755576;30247.848760756056;30455.543166852516;1854.8423384012376;1875.793662697116;1881.9341323053764;1882.2471011595335;1885.5097674604565;19299.22803087875;19793;19934.40196794084;19968.400947971582;19975.700364494543;2378.356951739177;2392.8564286142887;2409.5662780699467;2410.3612542676206;2462.630605409203;137022;140120.99999999898;140981;143559;145772.2711386447;13853.30733463343;14640.267986600627;15016.399344026335;15069.54791356261;15358.385664573292;23246;23279.3016209514;23326.416839578807;23351.53296934052;23388.532229355318;9942;10148.847767283496;10202.948985255027;10294.838084002444;10384.480775961172;8227.54748488827;9079.954600226956;9164.8625270621;9261.907380926104;9470.857937130948;8264.884240627558;9076.455412675261;9165.358424910326;9171.312151588658;9275.62897484093;2647.377866201441;2710.566309390488;2772.4177922636068;2815.888443270198;2870.2680816391685;933.4725879877983;946.3375637054089;954.4230577440937;960.2462067277294;973.8977407372265;19197.90401047986;19680.70478942817;24163.39591510191;25563.23310300694;25902.22293331203;1011.6459239266198;1017.7964407118606;1026.4046852825343;1031.6131450705984;1034.2088302448633;11099.334039957628;11267.26762760418;11407.543698252142;11416.771664566662;11503.884961150281;508084;509451;519606;522255;532497;116739.41630291964;119097.99999999827;120024;120485;121859;1220.0849362977767;1252.2486508095253;1269.2701696524534;1271.2309053022973;1281.705207802192;17645.73531397056;17743.73384399261;17817.1982260796;18105.185266663295;18364.265429382674;59095;59251.70374148102;61277.69361153344;61486;61567.69216153891;70874;73706.26293736995;73810;74357.6282118586;74633;11643.650690479299;11974.161808673658;14014.159150451005;14195.290235487977;14577.416903323749;22889.656655149854;22970.54058918846;23252.53494930058;23260;23315.183968561018;18266.178021989308;18271.725924110884;19146.138423770684;19309.613807724047;19338.129784159464;17630.382936597158;17739.733903991193;17754.733678995082;18038.458846234633;18161.636767264317;19234.23063077461;19497.220111195395;19536.120874560394;19707.40877773669;19900;14751.778723318945;14831.184284864436;14920;14967.176805275814;14973;18708.6258274831;19137.23451061942;19178.616427671648;19219;19548.31580894662 17:31:39 INFO - PID 11344 | |3;mootools.html;1331.8534961154273;1387.8959078069147;1400.3278426355348;1414.1797757300767;1417.9858201417985;14119.505817296396;14178.787318190223;14615.415383384678;14809.925950370247;14827.481038163667;14622.561323160297;14879.479218227365;14882.107073575566;14924.850751492482;14936.701265974674;2619.3713508757905;2661.653984981959;2669.9733002670014;2676.558367869299;2694.528457519936;2531.3291977625945;2611.994382162862;2754.063618369754;2756.490049340878;2758.613794068832;2689.3276680829795;2715.321169707573;2740.3834137319145;2742.5886117082396;2745.1901689001793;2646.5103955768245;2663.4539919316494;2681.1018308866555;2712.8643567821728;2720.4287099709086;2610.6606141201523;2642.8150029497942;2661.534231509478;2662.001749343996;2678.8526631035284;14254.429822807075;14340.354684039243;14348.354324055443;14357.78463323051;14380.712385752226;7482.064741907262;7712.768616941501;7722.652480638385;7734.1492435832015;7762.534247945141;5159.896802063938;5319.627626066177;5425.891482170335;5431.592630552725;5449.482299181611;1812.3203798575535;1860.8139186081419;1862.9068546572753;1916.932907348236;1929.170456703617;22923.541529169324;23335.649965250534;23597.76402235973;23608.527829443316;23611.645825312633;6474.255460621995;6527.902081468782;6703.229128650268;6760.3239676032;6771.119754431892;16014.119223442589;16134.75797863033;16232.350705971865;16308.429204977769;16313.67372652564;7370.262973702587;7502.399808015346;7503.924960750432;7504.3246107850555;7514.248575142551;6883.8967415488805;6960.095187625576;6978.127734033246;6991.671582399328;7019.122609673791;5114.619052855708;5243.187305967581;5256.6057545684225;5259.579233661298;5283.762230699551;1449.1232804153547;1458.3947661720267;1465.5456808389433;1477.290900367808;1479.5931118942376;872.7032808844896;896.1665650944553;908.9954550227206;909.377076702461;910.0717268386209;7374.631268436557;7485.70057197706;7511.436642251853;7526.924730752732;7596.430267729942;712.568895818033;715.4097869257884;716.9641517924083;724.2829598697357;731.5756861020702;4582.908341833211;5157.226416037549;5218.817341393033;5275.788968441219;5309.256704061435;18752.812471875106;19255.256994761665;19657.705134422995;19711;19939;19357.51606209856;19535.21859125619;20037.899810500854;20089.19643214255;20155.899220503805;10699.73250668724;10867.29362591429;10878.836817447585;10992.560297588167;11074.723131921604;7906.960465197637;8024.679012839421;8118.553479558681;8181.222783835526;8249.133840946854;16963.321467141668;17157.91421042887;17248.396306129227;17336.913315433343;17763.378281760077;16971.15144242758;16998;17618.29526818913;17634;17903.37338193209;10964.725881853017;11055.447227638746;11513.481893314989;11520.193586448868;11538.94230528842;12733.172343797994;13010;13014.609561713163;13021.088523803242;13023.739525209632;10526.78946421052;10572.36565806054;10687.786244275227;10724.249302548747;10733.892661073289;10401.699787526559;10577.894221057692;10598.788024239626;10628.309159904582;10754.892451075702;9327.440353578808;9409.952950235205;9437.858432123387;9479.146876781122;9480.478573678514;6961.965190174017;7017;7066.540674856118;7083.468739844635;7110.680019399036;6920.653967301715;6949.861002779815;6959;6968.825779355557;7130.643467826691 17:31:39 INFO - PID 11344 | |4;prototype.html;499.54291822982;503.25872481215004;518.2278405176287;525.382675356456;532.616516108402;6295.370462953702;6295.716692748826;6298.338674439181;6300.085932972283;6305.527085468585;5967.075103358976;6121.418465245794;6157.230346206724;6159.599626024316;6169.444749972513;4948.7773050212645;4959.776810043557;5003.324551185598;5018.222175562793;5038.722870242135;4942.135126352892;4958.330625365584;4958.404991401037;5006.874828129307;5014.674046187004;4757.738324392157;4953.306537084793;4963.875903102416;4966.180580204262;4968.30443737877;4952.579030782388;4964.156093464084;4972.602191824663;4983.775730092155;4984.87537811554;4427.358033085185;4442.311441726538;4459.308807134899;4468.977655111704;4503.617192538638;5967.134765459027;6017.548683848729;6040.154378387029;6056.788012419588;6060.787872424488;5735.168400581934;5747.821696552197;5750.453706897838;5756.280464941882;5758.539316854683;6393.168888044571;6429.4856411487435;6452.903206451907;6496.805095847132;6508.967455162741;4835.1296766582;4867.541891344884;4869.318295438641;4874.878128046792;4894.192458244385;6748.19021717397;6834.316568343175;6878.693048320803;6970.128733908262;6989.266127056637;4962.404511458648;4980.626453016038;5010.342450011512;5022.84931452057;5040.143175660147;5097.46476619957;5108.2848401223855;5109.9744501277255;5123.513266239701;5127.589792816566;5744.281964754406;5748.045664474099;5776.740046697909;5781.248437703156;5796.275465566804;6431.742730290736;6499.545031847725;6537.313582073909;6591.274959754423;6603.240627327918;1672.6152984813318;1697.6604679064237;1734.6617409605258;1753.19353097574;1773.184335205794;1214.8117041858527;1236.3262022197923;1240.8138779183014;1242.9005679545614;1251.3492983648453;5685.0619647758485;5695.629784064023;5710;5725.370209276976;5746.798862039808;6417.1657684500715;6461.19235095613;6576.980568011966;6594.175728033996;6603.306652801387;5680.744366503517;5698.287714035746;5706.572007099484;5711.029125048752;5748.425157484302;3526.7656320287692;3553.3959226931483;3590.2460483298278;3603.891883243507;3630.8366123524506;6437.324080971524;6452.9677351612945;6474.417302442708;6541.738330466823;6547;6805.829854253584;6830.282820303896;6867.2102708188195;6871;6899.793006209822;6409.166808314889;6418.042497038355;6434.324395938359;6460.160179176677;6490.253620833664;6612.371824676648;6625.370589793962;6647.434968027772;6677.465802735673;6741.460683145238;6620.404163625297;6651.46788256948;6651.63416012124;6663.999999999806;6709;6357.777477788255;6378.170837791057;6425.1968503937005;6446.485076007229;6462.612243265419;4927.137750893651;4958.479359667183;4965.205567109245;4988.80044798204;5022.799088036438;6706.765263215764;6747.402250133832;6762.6618669065365;6773.93226067733;6789.15135608049;6500.869982600416;6503.934960650333;6513.446357059703;6547.70535325921;6570.178727659043;6440.162778838909;6491.935080649133;6497.18785151856;6524.2823289439075;6554.705038273384;6099.634021958696;6182.412670796267;6244.000959846403;6394.4884409246215;6414.679266036773;6457.128287681291;6459.709313080829;6556.934430655823;6569.310222426768;6570.277269500256;6252.374762523711;6276.4308922769305;6313.526485513513;6334.606386594942;6430.453411459891 17:31:39 INFO - PID 11344 | |5;yui.html;866.4887716247413;886.7827382291339;899.5682072605154;907.6188001039562;909.8089401225742;19016.524586885334;19556.31552895649;19839.10724017419;19839.908805015737;22198;17347;17392.56518587036;17409.65180696385;18246.543836404097;21592.3522294331;1031.9742006449824;1055.9208059395537;1056.5245639462235;1058.613606033796;1063.1229235880392;1048.119579553175;1067.6583493282153;1071.4482041748506;1071.566015763617;1074.661481633287;1036.7304500829764;1085.1047885494459;1089.199438412766;1097.3909480238465;1109.4840898982013;1069.561479793285;1070.946452677363;1072.8873468285835;1072.9409882456462;1077.7197928538637;780.001597954619;789.5460110436522;789.7986013566561;790.7311514085181;795.0181525815613;19751.506212344662;19794.40616781499;20073.096710648057;20085.497862553406;20406.285779997776;21770.89114554433;22380.55238895213;22607.208747693752;22644.094236230532;22810.543789124124;16661.91669041659;16888.493345199542;16905.66188676232;16934.91532542342;17005.659886802194;3472.097254713767;3484.703800176988;3484.7212223022098;3490.2844916791996;3512.227309991798;133402.3329883354;133497.33251333778;133899.33050334782;134049;138474;16269.837301626832;16662.00027998324;16756.413525526546;16987.235574399183;16999.830001700073;30322;30888.691113088582;31196.844015779774;31710.524342134886;31771.682283177335;8650.437721548205;8665.220130188314;8740.038595754462;8795.648174073094;8796.34027447944;4200.369944508348;4304.548022457597;4319.503257125471;4325.329573916048;4326.610605045561;5326;5402;5428.158635411518;5433.864153396196;5487.176923461513;967.192394350711;981.8821741391079;985.9950700246596;998.8651532043226;999.5502024089044;623.1525125828869;633.1452539072216;635.2630948100182;643.4980715042275;658.06554692337;10686.51910664022;10785.460726963778;10922.344659320466;11407.144464165222;11572.132090093277;626.326698798784;633.1484153813115;633.2654121219364;635.1457289945016;645.6771614192903;5113.923291150636;5116.641835071584;5201.323827902348;5203.141481655484;5256.816011439581;109374;111718.44140779244;112993.43503282432;113925;114500;73641.6317918407;95448;97198.5140074295;98954.5052274734;104498.47750761197;87376.56311718527;87735;88570.11429885747;91157.54421227984;91218;11931.642050738492;11938.940305298418;11996.280223186637;12583.208073867238;12747.362631868555;38681.6131838678;38844.80577597094;39581.208375831746;39849.40225896672;41880.3717944225;67439.66280168567;68676.6566167166;69598;70061.64969175121;73226;17519.912400437915;17530.73703894417;17545.56136096608;17798.199081041126;17811.19849606745;19781.80218197857;19782.802171978095;20771.961401930144;20797.688034679188;20891.477713056687;17483.388081417597;17944.19251133676;18026.549336266697;18126.818731812513;18354.08229588542;18482.353117640818;18766.437006889813;18866.905665471586;18995.335163269217;19386.8061319385;17466.21402036886;17586.82413175903;17943.73084403761;18010;18110;12843.935780321039;12872.420741066862;13625.386857591235;13760.449582017007;14238.572842814732;14003.299835008413;14014.439422422989;14046.578602641937;14334.713305733618;14778 17:31:39 INFO - PID 11344 | __end_tp_report 17:31:39 INFO - PID 11344 | __start_cc_report 17:31:39 INFO - PID 11344 | _x_x_mozilla_cycle_collect,369 17:31:39 INFO - PID 11344 | __end_cc_report 17:31:39 INFO - PID 11344 | __startTimestamp1502670699472__endTimestamp 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | ------- Summary: start ------- 17:31:39 INFO - PID 11344 | Number of tests: 6 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | [#0] dojo.html Cycles:165 Average:6120.65 Median:6386.62 stddev:724.30 (11.3%) stddev-sans-first:687.08 17:31:39 INFO - PID 11344 | Values: 3115.5 3136.8 3158.9 3161.1 3197.9 6036.4 6088.6 6092.7 6143.8 6144.0 6021.4 6041.4 6102.5 6112.4 6121.8 5600.1 5602.4 5627.4 5664.2 5677.5 5624.0 5629.1 5647.9 5650.1 5689.7 5621.8 5708.6 5765.3 5772.4 5773.8 5693.0 5723.1 5756.9 5774.7 5800.4 5529.9 5540.2 5631.9 5674.6 5694.3 6085.7 6109.3 6110.1 6122.2 6147.8 6644.0 6741.5 6764.7 6772.8 6779.3 6698.8 6749.3 6780.1 6815.4 6840.1 6061.6 6140.8 6168.6 6219.5 6251.1 6817.6 6820.8 6825.8 6840.4 6870.2 6464.4 6487.6 6567.3 6573.4 6573.9 6492.4 6553.2 6560.4 6576.3 6713.4 6554.3 6586.0 6588.2 6599.9 6605.5 6650.8 6679.9 6719.1 6745.5 6755.0 5326.6 5340.5 5352.8 5436.7 5450.1 4560.0 4601.6 4604.0 4608.1 4619.1 5778.1 5832.3 5833.9 5848.5 5853.4 6697.9 6743.4 6773.8 6806.0 6808.6 5628.7 5759.6 5774.9 5822.9 5835.2 5864.5 5909.2 5953.5 5964.1 5978.4 6480.9 6482.2 6547.1 6551.5 6558.2 6688.5 6691.1 6700.5 6782.4 6785.1 6308.3 6387.9 6423.4 6423.7 6435.4 6426.3 6442.2 6470.2 6473.4 6528.2 6538.8 6561.5 6647.7 6663.6 6720.4 6499.9 6502.3 6523.3 6564.4 6585.1 6415.0 6436.5 6478.4 6517.4 6534.0 6309.9 6311.0 6328.9 6347.8 6435.9 6468.2 6471.9 6478.9 6480.3 6537.1 6245.5 6340.7 6386.6 6421.7 6429.2 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | [#1] ext.html Cycles:180 Average:37364.00 Median:3423.24 stddev:53939.49 (1575.7%) stddev-sans-first:54020.68 17:31:39 INFO - PID 11344 | Values: 734.0 776.3 799.2 805.4 1131.7 30234.7 30883.7 40453.2 41302.0 41789.8 41555.6 41835.4 41840.4 42056.4 42122.0 7447.2 7591.9 7595.3 7597.6 7601.8 7465.8 7480.5 7553.3 7558.2 7580.4 7097.8 7504.6 7530.5 7600.9 7665.3 7570.4 7634.8 7641.0 7641.2 7643.0 7352.8 7380.0 7504.5 7520.9 7561.7 37710.6 38106.0 38132.0 38338.6 38435.2 3420.9 3425.6 3429.1 3459.9 3467.6 30889.8 30978.4 31239.7 31267.7 31463.7 4980.6 5024.7 5066.1 5076.9 5081.6 174423.0 179630.0 179739.1 179783.0 181724.0 47017.0 47221.3 47303.8 47395.8 47476.0 49166.3 49306.3 49394.0 49632.3 49682.5 15116.3 15136.1 15273.7 15323.2 15356.7 12572.3 12581.8 12593.2 12594.3 12605.4 14180.1 14196.1 14198.0 14307.6 14360.5 4871.1 5764.7 5829.3 5915.2 5917.6 981.2 998.3 1003.2 1008.2 1017.3 22547.1 28187.4 28987.6 29256.6 29539.7 1039.2 1073.7 1076.3 1087.1 1090.9 12147.2 12218.8 12289.9 12294.1 12304.9 236609.0 236989.0 238090.0 238575.0 242258.0 51235.0 51251.2 51351.2 51399.0 51900.0 1413.2 1473.1 1477.2 1478.9 1479.6 21719.5 22357.4 22385.0 22743.4 22781.2 36493.0 36520.5 36699.3 36888.6 37024.8 200838.0 201148.0 201897.0 204247.0 204384.0 33244.8 33893.3 33996.8 34179.5 34283.1 35889.5 36182.0 42827.6 43034.4 43295.8 28740.0 31159.8 31264.5 31376.4 31745.2 30578.2 31179.8 31199.8 31297.4 31644.0 34135.0 37581.4 38494.8 38643.4 38677.4 33181.5 33206.3 33274.5 33738.8 34330.7 22317.2 24370.5 24560.9 24699.6 24817.4 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | [#2] jquery.html Cycles:180 Average:36097.53 Median:23269.65 stddev:87221.12 (374.8%) stddev-sans-first:87424.96 17:31:39 INFO - PID 11344 | Values: 547.5 554.3 559.3 562.4 571.9 21565.4 22323.2 22431.1 22677.1 22715.9 24675.0 25459.0 26282.6 26288.6 26650.6 6389.5 6585.0 6593.6 6604.6 6651.8 6269.5 6459.4 6503.7 6539.2 6563.9 6476.2 6516.8 6517.3 6517.7 6524.1 6458.7 6473.4 6473.6 6519.7 6527.7 5998.1 5999.3 6020.6 6022.6 6028.0 28504.9 29611.4 30219.8 30247.8 30455.5 1854.8 1875.8 1881.9 1882.2 1885.5 19299.2 19793.0 19934.4 19968.4 19975.7 2378.4 2392.9 2409.6 2410.4 2462.6 137022.0 140121.0 140981.0 143559.0 145772.3 13853.3 14640.3 15016.4 15069.5 15358.4 23246.0 23279.3 23326.4 23351.5 23388.5 9942.0 10148.8 10202.9 10294.8 10384.5 8227.5 9080.0 9164.9 9261.9 9470.9 8264.9 9076.5 9165.4 9171.3 9275.6 2647.4 2710.6 2772.4 2815.9 2870.3 933.5 946.3 954.4 960.2 973.9 19197.9 19680.7 24163.4 25563.2 25902.2 1011.6 1017.8 1026.4 1031.6 1034.2 11099.3 11267.3 11407.5 11416.8 11503.9 508084.0 509451.0 519606.0 522255.0 532497.0 116739.4 119098.0 120024.0 120485.0 121859.0 1220.1 1252.2 1269.3 1271.2 1281.7 17645.7 17743.7 17817.2 18105.2 18364.3 59095.0 59251.7 61277.7 61486.0 61567.7 70874.0 73706.3 73810.0 74357.6 74633.0 11643.7 11974.2 14014.2 14195.3 14577.4 22889.7 22970.5 23252.5 23260.0 23315.2 18266.2 18271.7 19146.1 19309.6 19338.1 17630.4 17739.7 17754.7 18038.5 18161.6 19234.2 19497.2 19536.1 19707.4 19900.0 14751.8 14831.2 14920.0 14967.2 14973.0 18708.6 19137.2 19178.6 19219.0 19548.3 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | [#3] mootools.html Cycles:180 Average:8806.76 Median:2654.02 stddev:6061.91 (228.4%) stddev-sans-first:6052.90 17:31:39 INFO - PID 11344 | Values: 1331.9 1387.9 1400.3 1414.2 1418.0 14119.5 14178.8 14615.4 14809.9 14827.5 14622.6 14879.5 14882.1 14924.9 14936.7 2619.4 2661.7 2670.0 2676.6 2694.5 2531.3 2612.0 2754.1 2756.5 2758.6 2689.3 2715.3 2740.4 2742.6 2745.2 2646.5 2663.5 2681.1 2712.9 2720.4 2610.7 2642.8 2661.5 2662.0 2678.9 14254.4 14340.4 14348.4 14357.8 14380.7 7482.1 7712.8 7722.7 7734.1 7762.5 5159.9 5319.6 5425.9 5431.6 5449.5 1812.3 1860.8 1862.9 1916.9 1929.2 22923.5 23335.6 23597.8 23608.5 23611.6 6474.3 6527.9 6703.2 6760.3 6771.1 16014.1 16134.8 16232.4 16308.4 16313.7 7370.3 7502.4 7503.9 7504.3 7514.2 6883.9 6960.1 6978.1 6991.7 7019.1 5114.6 5243.2 5256.6 5259.6 5283.8 1449.1 1458.4 1465.5 1477.3 1479.6 872.7 896.2 909.0 909.4 910.1 7374.6 7485.7 7511.4 7526.9 7596.4 712.6 715.4 717.0 724.3 731.6 4582.9 5157.2 5218.8 5275.8 5309.3 18752.8 19255.3 19657.7 19711.0 19939.0 19357.5 19535.2 20037.9 20089.2 20155.9 10699.7 10867.3 10878.8 10992.6 11074.7 7907.0 8024.7 8118.6 8181.2 8249.1 16963.3 17157.9 17248.4 17336.9 17763.4 16971.2 16998.0 17618.3 17634.0 17903.4 10964.7 11055.4 11513.5 11520.2 11538.9 12733.2 13010.0 13014.6 13021.1 13023.7 10526.8 10572.4 10687.8 10724.2 10733.9 10401.7 10577.9 10598.8 10628.3 10754.9 9327.4 9410.0 9437.9 9479.1 9480.5 6962.0 7017.0 7066.5 7083.5 7110.7 6920.7 6949.9 6959.0 6968.8 7130.6 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | [#4] prototype.html Cycles:180 Average:5487.39 Median:6080.21 stddev:1531.43 (25.2%) stddev-sans-first:1489.26 17:31:39 INFO - PID 11344 | Values: 499.5 503.3 518.2 525.4 532.6 6295.4 6295.7 6298.3 6300.1 6305.5 5967.1 6121.4 6157.2 6159.6 6169.4 4948.8 4959.8 5003.3 5018.2 5038.7 4942.1 4958.3 4958.4 5006.9 5014.7 4757.7 4953.3 4963.9 4966.2 4968.3 4952.6 4964.2 4972.6 4983.8 4984.9 4427.4 4442.3 4459.3 4469.0 4503.6 5967.1 6017.5 6040.2 6056.8 6060.8 5735.2 5747.8 5750.5 5756.3 5758.5 6393.2 6429.5 6452.9 6496.8 6509.0 4835.1 4867.5 4869.3 4874.9 4894.2 6748.2 6834.3 6878.7 6970.1 6989.3 4962.4 4980.6 5010.3 5022.8 5040.1 5097.5 5108.3 5110.0 5123.5 5127.6 5744.3 5748.0 5776.7 5781.2 5796.3 6431.7 6499.5 6537.3 6591.3 6603.2 1672.6 1697.7 1734.7 1753.2 1773.2 1214.8 1236.3 1240.8 1242.9 1251.3 5685.1 5695.6 5710.0 5725.4 5746.8 6417.2 6461.2 6577.0 6594.2 6603.3 5680.7 5698.3 5706.6 5711.0 5748.4 3526.8 3553.4 3590.2 3603.9 3630.8 6437.3 6453.0 6474.4 6541.7 6547.0 6805.8 6830.3 6867.2 6871.0 6899.8 6409.2 6418.0 6434.3 6460.2 6490.3 6612.4 6625.4 6647.4 6677.5 6741.5 6620.4 6651.5 6651.6 6664.0 6709.0 6357.8 6378.2 6425.2 6446.5 6462.6 4927.1 4958.5 4965.2 4988.8 5022.8 6706.8 6747.4 6762.7 6773.9 6789.2 6500.9 6503.9 6513.4 6547.7 6570.2 6440.2 6491.9 6497.2 6524.3 6554.7 6099.6 6182.4 6244.0 6394.5 6414.7 6457.1 6459.7 6556.9 6569.3 6570.3 6252.4 6276.4 6313.5 6334.6 6430.5 17:31:39 INFO - PID 11344 | 17:31:39 INFO - PID 11344 | [#5] yui.html Cycles:180 Average:24020.55 Median:19816.76 stddev:33059.88 (166.8%) stddev-sans-first:33106.91 17:31:39 INFO - PID 11344 | Values: 866.5 886.8 899.6 907.6 909.8 19016.5 19556.3 19839.1 19839.9 22198.0 17347.0 17392.6 17409.7 18246.5 21592.4 1032.0 1055.9 1056.5 1058.6 1063.1 1048.1 1067.7 1071.4 1071.6 1074.7 1036.7 1085.1 1089.2 1097.4 1109.5 1069.6 1070.9 1072.9 1072.9 1077.7 780.0 789.5 789.8 790.7 795.0 19751.5 19794.4 20073.1 20085.5 20406.3 21770.9 22380.6 22607.2 22644.1 22810.5 16661.9 16888.5 16905.7 16934.9 17005.7 3472.1 3484.7 3484.7 3490.3 3512.2 133402.3 133497.3 133899.3 134049.0 138474.0 16269.8 16662.0 16756.4 16987.2 16999.8 30322.0 30888.7 31196.8 31710.5 31771.7 8650.4 8665.2 8740.0 8795.6 8796.3 4200.4 4304.5 4319.5 4325.3 4326.6 5326.0 5402.0 5428.2 5433.9 5487.2 967.2 981.9 986.0 998.9 999.6 623.2 633.1 635.3 643.5 658.1 10686.5 10785.5 10922.3 11407.1 11572.1 626.3 633.1 633.3 635.1 645.7 5113.9 5116.6 5201.3 5203.1 5256.8 109374.0 111718.4 112993.4 113925.0 114500.0 73641.6 95448.0 97198.5 98954.5 104498.5 87376.6 87735.0 88570.1 91157.5 91218.0 11931.6 11938.9 11996.3 12583.2 12747.4 38681.6 38844.8 39581.2 39849.4 41880.4 67439.7 68676.7 69598.0 70061.6 73226.0 17519.9 17530.7 17545.6 17798.2 17811.2 19781.8 19782.8 20772.0 20797.7 20891.5 17483.4 17944.2 18026.5 18126.8 18354.1 18482.4 18766.4 18866.9 18995.3 19386.8 17466.2 17586.8 17943.7 18010.0 18110.0 12843.9 12872.4 13625.4 13760.4 14238.6 14003.3 14014.4 14046.6 14334.7 14778.0 17:31:39 INFO - PID 11344 | -------- Summary: end -------- 17:31:39 INFO - PID 11344 | 17:31:40 INFO - TEST-INFO | 11344: exit 0 17:31:40 INFO - TEST-OK | dromaeo_css | took 1111901ms 17:31:40 INFO - TEST-START | kraken 17:31:40 INFO - Initialising browser for kraken test... 17:31:40 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52184/getInfo.html -profile /tmp/tmpYa0Br2/profile 17:31:40 INFO - TEST-INFO | started process 11733 (/builds/slave/test/build/application/firefox/firefox http://localhost:52184/getInfo.html) 17:31:45 INFO - TEST-INFO | 11733: exit 0 17:31:45 INFO - Browser initialized. 17:31:45 INFO - Running cycle 1/1 for kraken test... 17:31:45 INFO - TEST-INFO | started process 11964 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYa0Br2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 17:31:46 INFO - PID 11964 | 17:31:46 INFO - PID 11964 | (/builds/slave/test/build/application/firefox/firefox:12019): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 17:31:46 INFO - PID 11964 | 17:31:57 INFO - PID 11964 | RSS: Main: 168022016 17:31:57 INFO - PID 11964 | 17:31:59 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52184/tests/kraken/driver.html?testName=audio-beat-detection) 17:32:00 INFO - PID 11964 | RSS: Main: 174313472 17:32:00 INFO - PID 11964 | 17:32:03 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52184/tests/kraken/driver.html?testName=audio-dft) 17:32:04 INFO - PID 11964 | RSS: Main: 178122752 17:32:04 INFO - PID 11964 | 17:32:07 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52184/tests/kraken/driver.html?testName=audio-fft) 17:32:07 INFO - PID 11964 | RSS: Main: 172146688 17:32:07 INFO - PID 11964 | 17:32:10 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52184/tests/kraken/driver.html?testName=audio-oscillator) 17:32:10 INFO - PID 11964 | RSS: Main: 172298240 17:32:10 INFO - PID 11964 | 17:32:13 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52184/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:32:13 INFO - PID 11964 | RSS: Main: 172498944 17:32:13 INFO - PID 11964 | 17:32:16 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52184/tests/kraken/driver.html?testName=imaging-darkroom) 17:32:17 INFO - PID 11964 | RSS: Main: 173555712 17:32:17 INFO - PID 11964 | 17:32:20 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52184/tests/kraken/driver.html?testName=imaging-desaturate) 17:32:21 INFO - PID 11964 | RSS: Main: 172949504 17:32:21 INFO - PID 11964 | 17:32:24 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52184/tests/kraken/driver.html?testName=json-parse-financial) 17:32:25 INFO - PID 11964 | RSS: Main: 174317568 17:32:25 INFO - PID 11964 | 17:32:26 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52184/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:32:27 INFO - PID 11964 | RSS: Main: 174309376 17:32:27 INFO - PID 11964 | 17:32:29 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:32:29 INFO - PID 11964 | RSS: Main: 174448640 17:32:29 INFO - PID 11964 | 17:32:32 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:32:32 INFO - PID 11964 | RSS: Main: 174010368 17:32:32 INFO - PID 11964 | 17:32:35 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:32:36 INFO - PID 11964 | RSS: Main: 174743552 17:32:36 INFO - PID 11964 | 17:32:39 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:32:39 INFO - PID 11964 | RSS: Main: 175136768 17:32:39 INFO - PID 11964 | 17:32:41 INFO - PID 11964 | Cycle 1(1): loaded http://localhost:52184/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52184/tests/kraken/driver.html?testName=ai-astar) 17:32:42 INFO - PID 11964 | RSS: Main: 176140288 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | __start_tp_report 17:32:42 INFO - PID 11964 | _x_x_mozilla_page_load 17:32:42 INFO - PID 11964 | _x_x_mozilla_page_load_details 17:32:42 INFO - PID 11964 | |i|pagename|runs| 17:32:42 INFO - PID 11964 | |0;ai-astar;98;116;102;120;109;111;107;99;107;109 17:32:42 INFO - PID 11964 | |1;audio-beat-detection;148;127;163;184;127;160;145;119;171;121 17:32:42 INFO - PID 11964 | |2;audio-dft;164;164;166;165;163;165;166;175;171;172 17:32:42 INFO - PID 11964 | |3;audio-fft;76;84;79;171;76;75;75;81;162;76 17:32:42 INFO - PID 11964 | |4;audio-oscillator;79;78;138;79;82;83;132;84;83;135 17:32:42 INFO - PID 11964 | |5;imaging-gaussian-blur;117;115;116;117;123;119;117;118;121;119 17:32:42 INFO - PID 11964 | |6;imaging-darkroom;151;153;155;157;151;151;153;153;151;157 17:32:42 INFO - PID 11964 | |7;imaging-desaturate;95;94;95;94;95;95;94;94;94;95 17:32:42 INFO - PID 11964 | |8;json-parse-financial;62;56;55;59;60;55;55;56;59;60 17:32:42 INFO - PID 11964 | |9;json-stringify-tinderbox;54;54;54;54;54;55;59;55;55;58 17:32:42 INFO - PID 11964 | |10;stanford-crypto-aes;77;77;77;77;79;77;77;78;78;77 17:32:42 INFO - PID 11964 | |11;stanford-crypto-ccm;124;128;126;122;126;125;123;127;136;163 17:32:42 INFO - PID 11964 | |12;stanford-crypto-pbkdf2;194;183;176;199;180;178;190;174;181;184 17:32:42 INFO - PID 11964 | |13;stanford-crypto-sha256-iterative;72;71;69;69;67;69;69;67;75;71 17:32:42 INFO - PID 11964 | __end_tp_report 17:32:42 INFO - PID 11964 | __start_cc_report 17:32:42 INFO - PID 11964 | _x_x_mozilla_cycle_collect,952 17:32:42 INFO - PID 11964 | __end_cc_report 17:32:42 INFO - PID 11964 | __startTimestamp1502670762042__endTimestamp 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | ------- Summary: start ------- 17:32:42 INFO - PID 11964 | Number of tests: 14 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#0] ai-astar Cycles:10 Average:107.80 Median:113.50 stddev:6.97 (6.1%) stddev-sans-first:6.43 17:32:42 INFO - PID 11964 | Values: 98.0 116.0 102.0 120.0 109.0 111.0 107.0 99.0 107.0 109.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#1] audio-beat-detection Cycles:10 Average:146.50 Median:154.00 stddev:22.69 (14.7%) stddev-sans-first:24.06 17:32:42 INFO - PID 11964 | Values: 148.0 127.0 163.0 184.0 127.0 160.0 145.0 119.0 171.0 121.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#2] audio-dft Cycles:10 Average:167.10 Median:166.00 stddev:4.07 (2.5%) stddev-sans-first:4.16 17:32:42 INFO - PID 11964 | Values: 164.0 164.0 166.0 165.0 163.0 165.0 166.0 175.0 171.0 172.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#3] audio-fft Cycles:10 Average:95.50 Median:76.00 stddev:37.59 (49.5%) stddev-sans-first:39.20 17:32:42 INFO - PID 11964 | Values: 76.0 84.0 79.0 171.0 76.0 75.0 75.0 81.0 162.0 76.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#4] audio-oscillator Cycles:10 Average:97.30 Median:80.50 stddev:26.13 (32.5%) stddev-sans-first:26.86 17:32:42 INFO - PID 11964 | Values: 79.0 78.0 138.0 79.0 82.0 83.0 132.0 84.0 83.0 135.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.50 stddev:2.39 (2.0%) stddev-sans-first:2.50 17:32:42 INFO - PID 11964 | Values: 117.0 115.0 116.0 117.0 123.0 119.0 117.0 118.0 121.0 119.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#6] imaging-darkroom Cycles:10 Average:153.20 Median:153.00 stddev:2.39 (1.6%) stddev-sans-first:2.40 17:32:42 INFO - PID 11964 | Values: 151.0 153.0 155.0 157.0 151.0 151.0 153.0 153.0 151.0 157.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#7] imaging-desaturate Cycles:10 Average:94.50 Median:95.00 stddev:0.53 (0.6%) stddev-sans-first:0.53 17:32:42 INFO - PID 11964 | Values: 95.0 94.0 95.0 94.0 95.0 95.0 94.0 94.0 94.0 95.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#8] json-parse-financial Cycles:10 Average:57.70 Median:59.00 stddev:2.58 (4.4%) stddev-sans-first:2.22 17:32:42 INFO - PID 11964 | Values: 62.0 56.0 55.0 59.0 60.0 55.0 55.0 56.0 59.0 60.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#9] json-stringify-tinderbox Cycles:10 Average:55.20 Median:55.00 stddev:1.81 (3.3%) stddev-sans-first:1.87 17:32:42 INFO - PID 11964 | Values: 54.0 54.0 54.0 54.0 54.0 55.0 59.0 55.0 55.0 58.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#10] stanford-crypto-aes Cycles:10 Average:77.40 Median:77.00 stddev:0.70 (0.9%) stddev-sans-first:0.73 17:32:42 INFO - PID 11964 | Values: 77.0 77.0 77.0 77.0 79.0 77.0 77.0 78.0 78.0 77.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#11] stanford-crypto-ccm Cycles:10 Average:130.00 Median:126.50 stddev:12.22 (9.7%) stddev-sans-first:12.77 17:32:42 INFO - PID 11964 | Values: 124.0 128.0 126.0 122.0 126.0 125.0 123.0 127.0 136.0 163.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:183.90 Median:183.50 stddev:8.08 (4.4%) stddev-sans-first:7.69 17:32:42 INFO - PID 11964 | Values: 194.0 183.0 176.0 199.0 180.0 178.0 190.0 174.0 181.0 184.0 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.90 Median:70.00 stddev:2.42 (3.5%) stddev-sans-first:2.45 17:32:42 INFO - PID 11964 | Values: 72.0 71.0 69.0 69.0 67.0 69.0 69.0 67.0 75.0 71.0 17:32:42 INFO - PID 11964 | -------- Summary: end -------- 17:32:42 INFO - PID 11964 | 17:32:42 INFO - PID 11964 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 17:32:42 INFO - TEST-INFO | 11964: exit 0 17:32:42 INFO - TEST-OK | kraken | took 62603ms 17:32:42 INFO - SUITE-END | took 1174s 17:32:43 INFO - Completed test suite (00:19:34) 17:32:43 INFO - javascript benchmark 17:32:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8456.843611668222, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3115.4547954108025, 3136.7647426443023, 3158.9210269743253, 3161.130689060508, 3197.9200519987, 6036.3661815509395, 6088.634681919088, 6092.725827337769, 6143.8156855294355, 6144.0, 6021.397860213988, 6041.365656606059, 6102.450779429851, 6112.358202388752, 6121.785737499188, 5600.075987462084, 5602.38373778885, 5627.437256274381, 5664.150377443375, 5677.545796336304, 5623.971880140593, 5629.099344104944, 5647.8588035299035, 5650.06773882311, 5689.715514224293, 5621.831345059634, 5708.600397972144, 5765.250517432728, 5772.422757724236, 5773.826785196451, 5693.032184528619, 5723.112917497794, 5756.913646295288, 5774.740136693859, 5800.4489573490455, 5529.861753456155, 5540.196671482653, 5631.915521267143, 5674.574406919456, 5694.316681998187, 6085.726142323606, 6109.327973922865, 6110.052941794029, 6122.234720659918, 6147.815565533041, 6643.966780166116, 6741.528093033489, 6764.661766911635, 6772.8306792330095, 6779.254282028973, 6698.83252918676, 6749.291324410915, 6780.118584584022, 6815.352541508599, 6840.144981877265, 6061.605995610271, 6140.846478838065, 6168.599041062316, 6219.533534984849, 6251.093591429218, 6817.5568588041615, 6820.795376138723, 6825.761098361533, 6840.418564421981, 6870.175578930461, 6464.353564643498, 6487.643179625166, 6567.34326567349, 6573.375529324707, 6573.934260657428, 6492.415682588589, 6553.2136143663065, 6560.40956313934, 6576.342365763386, 6713.362230588184, 6554.344565543408, 6585.967070164715, 6588.209414870246, 6599.868002639921, 6605.504587155982, 6650.800475985729, 6679.931211006216, 6719.092922455406, 6745.460363171032, 6755.0, 5326.627136100436, 5340.546053585411, 5352.759125839269, 5436.700981446058, 5450.100733379028, 4559.954400456019, 4601.608863246594, 4603.976980115078, 4608.124456353282, 4619.145458090264, 5778.133280008033, 5832.270966129234, 5833.912491312633, 5848.5321174305955, 5853.385394533598, 6697.8995315070315, 6743.393094621508, 6773.762918297836, 6806.047153398528, 6808.5914845109455, 5628.662280263197, 5759.625624334405, 5774.88450230993, 5822.883542329129, 5835.183074369592, 5864.472197502245, 5909.172715819789, 5953.493953013955, 5964.105384192406, 5978.432048955342, 6480.870382592322, 6482.157319548429, 6547.1161393211305, 6551.541392102602, 6558.245801732766, 6688.531802773759, 6691.0967019451755, 6700.497462690415, 6782.355676210752, 6785.117934668461, 6308.27454842699, 6387.936120638734, 6423.357664233539, 6423.743050277936, 6435.420812126931, 6426.260979987362, 6442.226932768098, 6470.158879345843, 6473.352664733489, 6528.183977002875, 6538.8365290868105, 6561.475081993333, 6647.734090636513, 6663.600183988976, 6720.361565651256, 6499.935000649933, 6502.349765023459, 6523.3150519194805, 6564.409203171737, 6585.078089067439, 6415.0, 6436.517261205335, 6478.4169424752, 6517.4134327910715, 6534.0, 6309.873802524015, 6311.0217916223055, 6328.873422531431, 6347.841303967438, 6435.871282574416, 6468.15913931186, 6471.935280647133, 6478.870422591616, 6480.319566445455, 6537.117489139096, 6245.531585131042, 6340.71466784005, 6386.616802991835, 6421.743130274736, 6429.22849258092], "value": 6066.331357447983, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [733.9669714862831, 776.332354175409, 799.1648727080201, 805.3879051920542, 1131.6718151735997, 30234.697653023464, 30883.69116308839, 40453.190936181294, 41302.0, 41789.79105104478, 41555.58444415555, 41835.372469412905, 41840.37239441411, 42056.36915446271, 42122.0, 7447.18081011087, 7591.8861217081785, 7595.316421522062, 7597.582132982684, 7601.80995475112, 7465.776026719207, 7480.476366654337, 7553.282438168365, 7558.2063883292285, 7580.393568514505, 7097.751578694747, 7504.5872477013745, 7530.510516816389, 7600.923990760105, 7665.310122089011, 7570.3565196958325, 7634.770956871303, 7640.961795191016, 7641.235876412315, 7643.044619422572, 7352.816179595499, 7380.0405947227055, 7504.549727016397, 7520.887186692204, 7561.659725312375, 37710.62289377098, 38106.0, 38132.0, 38338.61661383379, 38435.231295374215, 3420.8973730788116, 3425.5889293284717, 3429.108431807723, 3459.8616055357757, 3467.5665541807275, 30889.845550772327, 30978.380432391452, 31239.687603124134, 31267.68732312693, 31463.685363146305, 4980.551750342451, 5024.748762561857, 5066.088104141253, 5076.923846142311, 5081.618878584121, 174423.0, 179630.0, 179739.10130449396, 179783.0, 181724.0, 47017.0, 47221.29168062482, 47303.763481182374, 47395.76302118467, 47476.0, 49166.262506062434, 49306.260406093934, 49394.0, 49632.255516167286, 49682.50317496851, 15116.319765610573, 15136.091834489966, 15273.694526109637, 15323.157226352658, 15356.692866142615, 12572.308523031139, 12581.811272830915, 12593.244405335709, 12594.307313097685, 12605.432755526022, 14180.078294910798, 14196.148231106166, 14198.0, 14307.64230894236, 14360.497382591559, 4871.131209155191, 5764.74058667361, 5829.271341082364, 5915.225432370272, 5917.5857689961285, 981.1562056631292, 998.3460833154296, 1003.1673710820002, 1008.2035192198082, 1017.308230403318, 22547.0981160755, 28187.43625127527, 28987.56518652222, 29256.561151582744, 29539.704602954123, 1039.2413538117066, 1073.7315671082229, 1076.2735153771173, 1087.130295763402, 1090.9454527273604, 12147.210431321935, 12218.816717749241, 12289.938550307192, 12294.139410241198, 12304.938475307745, 236609.0, 236989.0, 238090.0, 238575.0, 242258.0, 51235.0, 51251.23123153156, 51351.229731554056, 51399.0, 51900.0, 1413.2297897645808, 1473.1308527968336, 1477.224457159978, 1478.9260536973109, 1479.6300924768807, 21719.457013574785, 22357.44106397288, 22385.0, 22743.431414214778, 22781.202657906895, 36493.0, 36520.45219321659, 36699.26601467902, 36888.63111368852, 37024.81487592545, 200838.0, 201148.0, 201897.0, 204247.0, 204384.0, 33244.833775830964, 33893.3221335567, 33996.830015849766, 34179.48730768991, 34283.14292142716, 35889.46165807567, 36182.0, 42827.57172428236, 43034.41793492401, 43295.78352108345, 28740.0, 31159.84420077885, 31264.531032034993, 31376.372472550876, 31745.20636984094, 30578.235544111576, 31179.84410077935, 31199.84400077985, 31297.374052519277, 31644.0, 34135.0, 37581.43627845639, 38494.80752596219, 38643.420348695356, 38677.41983870188, 33181.50227746634, 33206.335873282886, 33274.500882487264, 33738.83130584331, 34330.65669343275, 22317.218897338516, 24370.512589747752, 24560.877195613906, 24699.62950555779, 24817.379565511008], "value": 16971.80529056873, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [547.5373309553429, 554.2683657572006, 559.3092530724557, 562.4319437368257, 571.894199573079, 21565.353039408823, 22323.218687345947, 22431.102755889766, 22677.09291628337, 22715.886420567873, 24675.0, 25459.0, 26282.6057609136, 26288.605670914905, 26650.600240996402, 6389.520785941061, 6585.012248162766, 6593.604383736967, 6604.603723776589, 6651.767188148416, 6269.529785266123, 6459.35406459355, 6503.707333169995, 6539.215294164707, 6563.868722625544, 6476.190476190476, 6516.804495865108, 6517.250516190627, 6517.67411629419, 6524.086627872078, 6458.709358078898, 6473.44975677068, 6473.579217350857, 6519.739210431577, 6527.738890444401, 5998.130271110665, 5999.250093738283, 6020.608660437058, 6022.638641681513, 6028.0, 28504.857475712695, 29611.407771844442, 30219.848900755576, 30247.848760756056, 30455.543166852516, 1854.8423384012376, 1875.793662697116, 1881.9341323053764, 1882.2471011595335, 1885.5097674604565, 19299.22803087875, 19793.0, 19934.40196794084, 19968.400947971582, 19975.700364494543, 2378.356951739177, 2392.8564286142887, 2409.5662780699467, 2410.3612542676206, 2462.630605409203, 137022.0, 140120.99999999898, 140981.0, 143559.0, 145772.2711386447, 13853.30733463343, 14640.267986600627, 15016.399344026335, 15069.54791356261, 15358.385664573292, 23246.0, 23279.3016209514, 23326.416839578807, 23351.53296934052, 23388.532229355318, 9942.0, 10148.847767283496, 10202.948985255027, 10294.838084002444, 10384.480775961172, 8227.54748488827, 9079.954600226956, 9164.8625270621, 9261.907380926104, 9470.857937130948, 8264.884240627558, 9076.455412675261, 9165.358424910326, 9171.312151588658, 9275.62897484093, 2647.377866201441, 2710.566309390488, 2772.4177922636068, 2815.888443270198, 2870.2680816391685, 933.4725879877983, 946.3375637054089, 954.4230577440937, 960.2462067277294, 973.8977407372265, 19197.90401047986, 19680.70478942817, 24163.39591510191, 25563.23310300694, 25902.22293331203, 1011.6459239266198, 1017.7964407118606, 1026.4046852825343, 1031.6131450705984, 1034.2088302448633, 11099.334039957628, 11267.26762760418, 11407.543698252142, 11416.771664566662, 11503.884961150281, 508084.0, 509451.0, 519606.0, 522255.0, 532497.0, 116739.41630291964, 119097.99999999827, 120024.0, 120485.0, 121859.0, 1220.0849362977767, 1252.2486508095253, 1269.2701696524534, 1271.2309053022973, 1281.705207802192, 17645.73531397056, 17743.73384399261, 17817.1982260796, 18105.185266663295, 18364.265429382674, 59095.0, 59251.70374148102, 61277.69361153344, 61486.0, 61567.69216153891, 70874.0, 73706.26293736995, 73810.0, 74357.6282118586, 74633.0, 11643.650690479299, 11974.161808673658, 14014.159150451005, 14195.290235487977, 14577.416903323749, 22889.656655149854, 22970.54058918846, 23252.53494930058, 23260.0, 23315.183968561018, 18266.178021989308, 18271.725924110884, 19146.138423770684, 19309.613807724047, 19338.129784159464, 17630.382936597158, 17739.733903991193, 17754.733678995082, 18038.458846234633, 18161.636767264317, 19234.23063077461, 19497.220111195395, 19536.120874560394, 19707.40877773669, 19900.0, 14751.778723318945, 14831.184284864436, 14920.0, 14967.176805275814, 14973.0, 18708.6258274831, 19137.23451061942, 19178.616427671648, 19219.0, 19548.31580894662], "value": 12099.618629071289, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1331.8534961154273, 1387.8959078069147, 1400.3278426355348, 1414.1797757300767, 1417.9858201417985, 14119.505817296396, 14178.787318190223, 14615.415383384678, 14809.925950370247, 14827.481038163667, 14622.561323160297, 14879.479218227365, 14882.107073575566, 14924.850751492482, 14936.701265974674, 2619.3713508757905, 2661.653984981959, 2669.9733002670014, 2676.558367869299, 2694.528457519936, 2531.3291977625945, 2611.994382162862, 2754.063618369754, 2756.490049340878, 2758.613794068832, 2689.3276680829795, 2715.321169707573, 2740.3834137319145, 2742.5886117082396, 2745.1901689001793, 2646.5103955768245, 2663.4539919316494, 2681.1018308866555, 2712.8643567821728, 2720.4287099709086, 2610.6606141201523, 2642.8150029497942, 2661.534231509478, 2662.001749343996, 2678.8526631035284, 14254.429822807075, 14340.354684039243, 14348.354324055443, 14357.78463323051, 14380.712385752226, 7482.064741907262, 7712.768616941501, 7722.652480638385, 7734.1492435832015, 7762.534247945141, 5159.896802063938, 5319.627626066177, 5425.891482170335, 5431.592630552725, 5449.482299181611, 1812.3203798575535, 1860.8139186081419, 1862.9068546572753, 1916.932907348236, 1929.170456703617, 22923.541529169324, 23335.649965250534, 23597.76402235973, 23608.527829443316, 23611.645825312633, 6474.255460621995, 6527.902081468782, 6703.229128650268, 6760.3239676032, 6771.119754431892, 16014.119223442589, 16134.75797863033, 16232.350705971865, 16308.429204977769, 16313.67372652564, 7370.262973702587, 7502.399808015346, 7503.924960750432, 7504.3246107850555, 7514.248575142551, 6883.8967415488805, 6960.095187625576, 6978.127734033246, 6991.671582399328, 7019.122609673791, 5114.619052855708, 5243.187305967581, 5256.6057545684225, 5259.579233661298, 5283.762230699551, 1449.1232804153547, 1458.3947661720267, 1465.5456808389433, 1477.290900367808, 1479.5931118942376, 872.7032808844896, 896.1665650944553, 908.9954550227206, 909.377076702461, 910.0717268386209, 7374.631268436557, 7485.70057197706, 7511.436642251853, 7526.924730752732, 7596.430267729942, 712.568895818033, 715.4097869257884, 716.9641517924083, 724.2829598697357, 731.5756861020702, 4582.908341833211, 5157.226416037549, 5218.817341393033, 5275.788968441219, 5309.256704061435, 18752.812471875106, 19255.256994761665, 19657.705134422995, 19711.0, 19939.0, 19357.51606209856, 19535.21859125619, 20037.899810500854, 20089.19643214255, 20155.899220503805, 10699.73250668724, 10867.29362591429, 10878.836817447585, 10992.560297588167, 11074.723131921604, 7906.960465197637, 8024.679012839421, 8118.553479558681, 8181.222783835526, 8249.133840946854, 16963.321467141668, 17157.91421042887, 17248.396306129227, 17336.913315433343, 17763.378281760077, 16971.15144242758, 16998.0, 17618.29526818913, 17634.0, 17903.37338193209, 10964.725881853017, 11055.447227638746, 11513.481893314989, 11520.193586448868, 11538.94230528842, 12733.172343797994, 13010.0, 13014.609561713163, 13021.088523803242, 13023.739525209632, 10526.78946421052, 10572.36565806054, 10687.786244275227, 10724.249302548747, 10733.892661073289, 10401.699787526559, 10577.894221057692, 10598.788024239626, 10628.309159904582, 10754.892451075702, 9327.440353578808, 9409.952950235205, 9437.858432123387, 9479.146876781122, 9480.478573678514, 6961.965190174017, 7017.0, 7066.540674856118, 7083.468739844635, 7110.680019399036, 6920.653967301715, 6949.861002779815, 6959.0, 6968.825779355557, 7130.643467826691], "value": 6374.189053204155, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [499.54291822982, 503.25872481215004, 518.2278405176287, 525.382675356456, 532.616516108402, 6295.370462953702, 6295.716692748826, 6298.338674439181, 6300.085932972283, 6305.527085468585, 5967.075103358976, 6121.418465245794, 6157.230346206724, 6159.599626024316, 6169.444749972513, 4948.7773050212645, 4959.776810043557, 5003.324551185598, 5018.222175562793, 5038.722870242135, 4942.135126352892, 4958.330625365584, 4958.404991401037, 5006.874828129307, 5014.674046187004, 4757.738324392157, 4953.306537084793, 4963.875903102416, 4966.180580204262, 4968.30443737877, 4952.579030782388, 4964.156093464084, 4972.602191824663, 4983.775730092155, 4984.87537811554, 4427.358033085185, 4442.311441726538, 4459.308807134899, 4468.977655111704, 4503.617192538638, 5967.134765459027, 6017.548683848729, 6040.154378387029, 6056.788012419588, 6060.787872424488, 5735.168400581934, 5747.821696552197, 5750.453706897838, 5756.280464941882, 5758.539316854683, 6393.168888044571, 6429.4856411487435, 6452.903206451907, 6496.805095847132, 6508.967455162741, 4835.1296766582, 4867.541891344884, 4869.318295438641, 4874.878128046792, 4894.192458244385, 6748.19021717397, 6834.316568343175, 6878.693048320803, 6970.128733908262, 6989.266127056637, 4962.404511458648, 4980.626453016038, 5010.342450011512, 5022.84931452057, 5040.143175660147, 5097.46476619957, 5108.2848401223855, 5109.9744501277255, 5123.513266239701, 5127.589792816566, 5744.281964754406, 5748.045664474099, 5776.740046697909, 5781.248437703156, 5796.275465566804, 6431.742730290736, 6499.545031847725, 6537.313582073909, 6591.274959754423, 6603.240627327918, 1672.6152984813318, 1697.6604679064237, 1734.6617409605258, 1753.19353097574, 1773.184335205794, 1214.8117041858527, 1236.3262022197923, 1240.8138779183014, 1242.9005679545614, 1251.3492983648453, 5685.0619647758485, 5695.629784064023, 5710.0, 5725.370209276976, 5746.798862039808, 6417.1657684500715, 6461.19235095613, 6576.980568011966, 6594.175728033996, 6603.306652801387, 5680.744366503517, 5698.287714035746, 5706.572007099484, 5711.029125048752, 5748.425157484302, 3526.7656320287692, 3553.3959226931483, 3590.2460483298278, 3603.891883243507, 3630.8366123524506, 6437.324080971524, 6452.9677351612945, 6474.417302442708, 6541.738330466823, 6547.0, 6805.829854253584, 6830.282820303896, 6867.2102708188195, 6871.0, 6899.793006209822, 6409.166808314889, 6418.042497038355, 6434.324395938359, 6460.160179176677, 6490.253620833664, 6612.371824676648, 6625.370589793962, 6647.434968027772, 6677.465802735673, 6741.460683145238, 6620.404163625297, 6651.46788256948, 6651.63416012124, 6663.999999999806, 6709.0, 6357.777477788255, 6378.170837791057, 6425.1968503937005, 6446.485076007229, 6462.612243265419, 4927.137750893651, 4958.479359667183, 4965.205567109245, 4988.80044798204, 5022.799088036438, 6706.765263215764, 6747.402250133832, 6762.6618669065365, 6773.93226067733, 6789.15135608049, 6500.869982600416, 6503.934960650333, 6513.446357059703, 6547.70535325921, 6570.178727659043, 6440.162778838909, 6491.935080649133, 6497.18785151856, 6524.2823289439075, 6554.705038273384, 6099.634021958696, 6182.412670796267, 6244.000959846403, 6394.4884409246215, 6414.679266036773, 6457.128287681291, 6459.709313080829, 6556.934430655823, 6569.310222426768, 6570.277269500256, 6252.374762523711, 6276.4308922769305, 6313.526485513513, 6334.606386594942, 6430.453411459891], "value": 5037.9605306489275, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [866.4887716247413, 886.7827382291339, 899.5682072605154, 907.6188001039562, 909.8089401225742, 19016.524586885334, 19556.31552895649, 19839.10724017419, 19839.908805015737, 22198.0, 17347.0, 17392.56518587036, 17409.65180696385, 18246.543836404097, 21592.3522294331, 1031.9742006449824, 1055.9208059395537, 1056.5245639462235, 1058.613606033796, 1063.1229235880392, 1048.119579553175, 1067.6583493282153, 1071.4482041748506, 1071.566015763617, 1074.661481633287, 1036.7304500829764, 1085.1047885494459, 1089.199438412766, 1097.3909480238465, 1109.4840898982013, 1069.561479793285, 1070.946452677363, 1072.8873468285835, 1072.9409882456462, 1077.7197928538637, 780.001597954619, 789.5460110436522, 789.7986013566561, 790.7311514085181, 795.0181525815613, 19751.506212344662, 19794.40616781499, 20073.096710648057, 20085.497862553406, 20406.285779997776, 21770.89114554433, 22380.55238895213, 22607.208747693752, 22644.094236230532, 22810.543789124124, 16661.91669041659, 16888.493345199542, 16905.66188676232, 16934.91532542342, 17005.659886802194, 3472.097254713767, 3484.703800176988, 3484.7212223022098, 3490.2844916791996, 3512.227309991798, 133402.3329883354, 133497.33251333778, 133899.33050334782, 134049.0, 138474.0, 16269.837301626832, 16662.00027998324, 16756.413525526546, 16987.235574399183, 16999.830001700073, 30322.0, 30888.691113088582, 31196.844015779774, 31710.524342134886, 31771.682283177335, 8650.437721548205, 8665.220130188314, 8740.038595754462, 8795.648174073094, 8796.34027447944, 4200.369944508348, 4304.548022457597, 4319.503257125471, 4325.329573916048, 4326.610605045561, 5326.0, 5402.0, 5428.158635411518, 5433.864153396196, 5487.176923461513, 967.192394350711, 981.8821741391079, 985.9950700246596, 998.8651532043226, 999.5502024089044, 623.1525125828869, 633.1452539072216, 635.2630948100182, 643.4980715042275, 658.06554692337, 10686.51910664022, 10785.460726963778, 10922.344659320466, 11407.144464165222, 11572.132090093277, 626.326698798784, 633.1484153813115, 633.2654121219364, 635.1457289945016, 645.6771614192903, 5113.923291150636, 5116.641835071584, 5201.323827902348, 5203.141481655484, 5256.816011439581, 109374.0, 111718.44140779244, 112993.43503282432, 113925.0, 114500.0, 73641.6317918407, 95448.0, 97198.5140074295, 98954.5052274734, 104498.47750761197, 87376.56311718527, 87735.0, 88570.11429885747, 91157.54421227984, 91218.0, 11931.642050738492, 11938.940305298418, 11996.280223186637, 12583.208073867238, 12747.362631868555, 38681.6131838678, 38844.80577597094, 39581.208375831746, 39849.40225896672, 41880.3717944225, 67439.66280168567, 68676.6566167166, 69598.0, 70061.64969175121, 73226.0, 17519.912400437915, 17530.73703894417, 17545.56136096608, 17798.199081041126, 17811.19849606745, 19781.80218197857, 19782.802171978095, 20771.961401930144, 20797.688034679188, 20891.477713056687, 17483.388081417597, 17944.19251133676, 18026.549336266697, 18126.818731812513, 18354.08229588542, 18482.353117640818, 18766.437006889813, 18866.905665471586, 18995.335163269217, 19386.8061319385, 17466.21402036886, 17586.82413175903, 17943.73084403761, 18010.0, 18110.0, 12843.935780321039, 12872.420741066862, 13625.386857591235, 13760.449582017007, 14238.572842814732, 14003.299835008413, 14014.439422422989, 14046.578602641937, 14334.713305733618, 14778.0], "value": 9143.605243587026, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1554.2000000000003, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [98.0, 116.0, 102.0, 120.0, 109.0, 111.0, 107.0, 99.0, 107.0, 109.0], "value": 107.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 127.0, 163.0, 184.0, 127.0, 160.0, 145.0, 119.0, 171.0, 121.0], "value": 146.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 164.0, 166.0, 165.0, 163.0, 165.0, 166.0, 175.0, 171.0, 172.0], "value": 167.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 84.0, 79.0, 171.0, 76.0, 75.0, 75.0, 81.0, 162.0, 76.0], "value": 95.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 78.0, 138.0, 79.0, 82.0, 83.0, 132.0, 84.0, 83.0, 135.0], "value": 97.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 115.0, 116.0, 117.0, 123.0, 119.0, 117.0, 118.0, 121.0, 119.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 153.0, 155.0, 157.0, 151.0, 151.0, 153.0, 153.0, 151.0, 157.0], "value": 153.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 95.0, 94.0, 95.0, 95.0, 94.0, 94.0, 94.0, 95.0], "value": 94.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 56.0, 55.0, 59.0, 60.0, 55.0, 55.0, 56.0, 59.0, 60.0], "value": 57.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 54.0, 54.0, 54.0, 55.0, 59.0, 55.0, 55.0, 58.0], "value": 55.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 77.0, 77.0, 79.0, 77.0, 77.0, 78.0, 78.0, 77.0], "value": 77.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 128.0, 126.0, 122.0, 126.0, 125.0, 123.0, 127.0, 136.0, 163.0], "value": 130.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [194.0, 183.0, 176.0, 199.0, 180.0, 178.0, 190.0, 174.0, 181.0, 184.0], "value": 183.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 71.0, 69.0, 69.0, 67.0, 69.0, 69.0, 67.0, 75.0, 71.0], "value": 69.9, "unit": "score"}]}]} 17:32:43 INFO - Return code: 0 17:32:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 17:32:43 INFO - # TBPL SUCCESS # 17:32:43 INFO - Running post-action listener: _package_coverage_data 17:32:43 INFO - Running post-action listener: _resource_record_post_action 17:32:43 INFO - [mozharness: 2017-08-14 00:32:43.293600Z] Finished run-tests step (success) 17:32:43 INFO - Running post-run listener: _resource_record_post_run 17:32:43 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 4096; Write bytes: 436154368; Read time: 16; Write time: 289712 17:32:43 INFO - TinderboxPrint: CPU usage
13.2% 17:32:43 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 17:32:43 INFO - TinderboxPrint: I/O write bytes / time
436,154,368 / 289,712 17:32:43 INFO - TinderboxPrint: CPU idle
8,255.5 (86.8%) 17:32:43 INFO - TinderboxPrint: CPU user
1,203.1 (12.7%) 17:32:43 INFO - TinderboxPrint: Swap in / out
0 / 0 17:32:43 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 112357376; Read time: 0; Write time: 101188 17:32:43 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 17:32:43 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 323796992; Read time: 0; Write time: 188524 17:32:43 INFO - Running post-run listener: _upload_blobber_files 17:32:43 INFO - Blob upload gear active. 17:32:43 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:32:43 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 17:32:43 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'] 17:32:43 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 17:32:44 INFO - (blobuploader) - INFO - Open directory for files ... 17:32:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 17:32:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:32:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:32:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 17:32:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:32:45 INFO - (blobuploader) - INFO - Done attempting. 17:32:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 17:32:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:32:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:32:46 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 17:32:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:32:46 INFO - (blobuploader) - INFO - Done attempting. 17:32:46 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 17:32:46 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:32:46 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:32:53 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 17:32:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:32:53 INFO - (blobuploader) - INFO - Done attempting. 17:32:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 17:32:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:32:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:32:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 17:32:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:32:54 INFO - (blobuploader) - INFO - Done attempting. 17:32:54 INFO - (blobuploader) - INFO - Iteration through files over. 17:32:54 INFO - Return code: 0 17:32:54 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:32:54 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:32:54 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8e4bbe91e0f25d0ca6a3ad85d8debda18f8c026ca3487245ade3e6cf234d2f3abd3623a202022c704232116d6a509ced0cadf91bee5db46ae981b1be9fc7d455", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98b17dd0a06a8a9e328f640102d50860e98624e029c2cfaf0d1d5f3f27be776c3e7f2818ae87086e326927e143920a899fa1f4d40d847c11898effaf98168c00", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d2700e597dfcb2f1fa7a0c6ba1aefe9131cc0d27a80de3e08fde0139b563b6da84cb832de3493548b1e27e3be097ff74479be86f462fcefb308cf78cef150250", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc2fe74741985750b424fc8f9b96a116a045ab2ab460faaf9cead7684082d20f64b550660dbb42176f021a9f9e95cdfe49b46ca95728f01c27f6545634172d2d"} 17:32:54 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:32:54 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:32:54 INFO - Contents: 17:32:54 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8e4bbe91e0f25d0ca6a3ad85d8debda18f8c026ca3487245ade3e6cf234d2f3abd3623a202022c704232116d6a509ced0cadf91bee5db46ae981b1be9fc7d455", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98b17dd0a06a8a9e328f640102d50860e98624e029c2cfaf0d1d5f3f27be776c3e7f2818ae87086e326927e143920a899fa1f4d40d847c11898effaf98168c00", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d2700e597dfcb2f1fa7a0c6ba1aefe9131cc0d27a80de3e08fde0139b563b6da84cb832de3493548b1e27e3be097ff74479be86f462fcefb308cf78cef150250", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc2fe74741985750b424fc8f9b96a116a045ab2ab460faaf9cead7684082d20f64b550660dbb42176f021a9f9e95cdfe49b46ca95728f01c27f6545634172d2d"} 17:32:54 INFO - Running post-run listener: copy_logs_to_upload_dir 17:32:54 INFO - Copying logs to upload dir... 17:32:54 INFO - mkdir: /builds/slave/test/build/upload/logs 17:32:54 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1257.435034 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-08-13 17:32:53.211431) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-13 17:32:53.215469) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8e4bbe91e0f25d0ca6a3ad85d8debda18f8c026ca3487245ade3e6cf234d2f3abd3623a202022c704232116d6a509ced0cadf91bee5db46ae981b1be9fc7d455", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98b17dd0a06a8a9e328f640102d50860e98624e029c2cfaf0d1d5f3f27be776c3e7f2818ae87086e326927e143920a899fa1f4d40d847c11898effaf98168c00", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d2700e597dfcb2f1fa7a0c6ba1aefe9131cc0d27a80de3e08fde0139b563b6da84cb832de3493548b1e27e3be097ff74479be86f462fcefb308cf78cef150250", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc2fe74741985750b424fc8f9b96a116a045ab2ab460faaf9cead7684082d20f64b550660dbb42176f021a9f9e95cdfe49b46ca95728f01c27f6545634172d2d"} build_url:https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011181 build_url: 'https://queue.taskcluster.net/v1/task/Cpe3HXCkQHyHzCn410T5Mw/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8e4bbe91e0f25d0ca6a3ad85d8debda18f8c026ca3487245ade3e6cf234d2f3abd3623a202022c704232116d6a509ced0cadf91bee5db46ae981b1be9fc7d455", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/98b17dd0a06a8a9e328f640102d50860e98624e029c2cfaf0d1d5f3f27be776c3e7f2818ae87086e326927e143920a899fa1f4d40d847c11898effaf98168c00", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d2700e597dfcb2f1fa7a0c6ba1aefe9131cc0d27a80de3e08fde0139b563b6da84cb832de3493548b1e27e3be097ff74479be86f462fcefb308cf78cef150250", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fc2fe74741985750b424fc8f9b96a116a045ab2ab460faaf9cead7684082d20f64b550660dbb42176f021a9f9e95cdfe49b46ca95728f01c27f6545634172d2d"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-13 17:32:53.241461) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-13 17:32:53.241846) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1502656449.17457-651944032 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004504 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-13 17:32:53.326616) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-13 17:32:53.327032) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-13 17:32:53.327562) ========= ========= Total master_lag: 0.22 =========